From 92b0a9fa9ff3b88df5118d8c6c870a2743e0f43c Mon Sep 17 00:00:00 2001
From: "Steinar H. Gunderson" <sgunderson@bigfoot.com>
Date: Sun, 14 Dec 2014 12:06:27 +0100
Subject: [PATCH] Output some cleaner statistics at end of book building.

---
 build-book.sh | 23 ++++++++++++++++++++++-
 1 file changed, 22 insertions(+), 1 deletion(-)

diff --git a/build-book.sh b/build-book.sh
index 67181c6..772f3fb 100755
--- a/build-book.sh
+++ b/build-book.sh
@@ -11,6 +11,8 @@ for FILE in "$@"; do
 	echo "$FILE" >> pgnnames.txt
 done
 
+TS_BEGIN=$( date +%s%3N )
+
 for X in $( seq 0 39 ); do
 	(
 		(
@@ -26,9 +28,28 @@ for X in $( seq 0 39 ); do
 done
 wait
 
-parallel -i -j ${PARALLEL_MERGES} bash -c 'X={}; set -x; ./binmerger tmp.mtbl.mapper*.part$( printf %04d $X ).subshard* open.mtbl.part$( printf %04d $X ).new' -- $( seq 0 $(( SHARDS - 1 )) )
+TS_MAPDONE=$( date +%s%3N )
+MAPOUTPUT=$( du -sch tmp.mtbl.mapper* | tail -n 1 | cut -f1 | sed 's/\([^0-9]\)$/ \1/' )
+
+echo "Reducing..."
+
+parallel -i -j ${PARALLEL_MERGES} bash -c 'X={}; ./binmerger tmp.mtbl.mapper*.part$( printf %04d $X ).subshard* open.mtbl.part$( printf %04d $X ).new' -- $( seq 0 $(( SHARDS - 1 )) )
+
+TS_REDUCEDONE=$( date +%s%3N )
+REDUCEOUTPUT=$( du -sch open.mtbl.part*.new | tail -n 1 | cut -f1 | sed 's/\([^0-9]\)$/ \1/' )
 
 for X in $( seq 0 $(( SHARDS - 1 )) ); do
 	mv open.mtbl.part$( printf %04d $X ).new open.mtbl.part$( printf %04d $X )
 done
 rm -f tmp.mtbl*
+
+TS_END=$( date +%s%3N )
+
+printf "\n"
+printf "  Map time:       %7d ms\n" $(( TS_MAPDONE - TS_BEGIN ))
+printf "  Reduce time:    %7d ms\n" $(( TS_REDUCEDONE - TS_MAPDONE ))
+printf "  Total time:     %7d ms\n" $(( TS_END - TS_BEGIN ))
+printf "\n"
+printf "  Map output:       %7sB\n" "$MAPOUTPUT"
+printf "  Reduce output:    %7sB\n" "$REDUCEOUTPUT"
+printf "\n"
-- 
2.39.2