__step=000067
__cmd_run=LD_PRELOAD=../../setbench/lib/libjemalloc.so timeout 180 numactl -i all /usr/bin/time -f "[time_cmd_output] time_elapsed_sec=%e, faults_major=%F, faults_minor=%R, mem_maxresident_kb=%M, user_cputime=%U, sys_cputime=%S, percent_cpu=%P" ./brown_sigouin_int_avl_tm_auto.debra.tl2 -nwork 96 -nprefill 96 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 5.0 5.0 -k 20000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000067.txt
__path_data=data/data000067.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6993742.672577050
binary=./brown_sigouin_int_avl_tm_auto.debra.tl2
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=brown_sigouin_int_avl_tm_auto
FIND_FUNC=FIND_FUNC
INSERT_FUNC=insertIfAbsent
ERASE_FUNC=ERASE_FUNC
RQ_FUNC=RQ_FUNC
RECLAIM=reclaimer_debra
ALLOC=allocator_new
POOL=pool_none
MAX_THREADS_POW2=512
CPU_FREQ_GHZ=2.1
MILLIS_TO_RUN=10000
INS_FRAC=5
DEL_FRAC=5
RQ=0
RQSIZE=0
MAXKEY=20000000
PREFILL_THREADS=96
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=96
WORK_THREADS=96
RQ_THREADS=0
distribution=0
INS_DEL_FRAC=5.0 5.0
PREFILL_TYPE=PREFILL_HYBRID
PREFILL_HYBRID_MIN_MS=1000
PREFILL_HYBRID_MAX_MS=5000
sizes: node=48
ACTUAL_THREAD_BINDINGS=0,1,2,3,4,5,6,7,8,9,10,11,12,13,14,15,16,17,18,19,20,21,22,23,96,97,98,99,100,101,102,103,104,105,106,107,108,109,110,111,112,113,114,115,116,117,118,119,24,25,26,27,28,29,30,31,32,33,34,35,36,37,38,39,40,41,42,43,44,45,46,47,120,121,122,123,124,125,126,127,128,129,130,131,132,133,134,135,136,137,138,139,140,141,142,143


TL2 system ready: GV=GV4
Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.014s
prefilling_size=3907934 prefilling_elapsed_millis=1.001s
prefilling_size=4203453 prefilling_elapsed_millis=1.101s
prefilling_size=4486140 prefilling_elapsed_millis=1.201s
prefilling_size=4752416 prefilling_elapsed_millis=1.301s
prefilling_size=5004864 prefilling_elapsed_millis=1.402s
prefilling_size=5248980 prefilling_elapsed_millis=1.502s
prefilling_size=5478313 prefilling_elapsed_millis=1.602s
prefilling_size=5699015 prefilling_elapsed_millis=1.702s
prefilling_size=5908570 prefilling_elapsed_millis=1.802s
prefilling_size=6105569 prefilling_elapsed_millis=1.903s
prefilling_size=6291838 prefilling_elapsed_millis=2.003s
prefilling_size=6471379 prefilling_elapsed_millis=2.103s
prefilling_size=6642024 prefilling_elapsed_millis=2.203s
prefilling_size=6804109 prefilling_elapsed_millis=2.303s
prefilling_size=6957000 prefilling_elapsed_millis=2.404s
prefilling_size=7102261 prefilling_elapsed_millis=2.504s
prefilling_size=7240704 prefilling_elapsed_millis=2.604s
prefilling_size=7374185 prefilling_elapsed_millis=2.704s
prefilling_size=7499717 prefilling_elapsed_millis=2.804s
prefilling_size=7620056 prefilling_elapsed_millis=2.905s
prefilling_size=7734292 prefilling_elapsed_millis=3.005s
prefilling_size=7844129 prefilling_elapsed_millis=3.105s
prefilling_size=7948158 prefilling_elapsed_millis=3.205s
prefilling_size=8046446 prefilling_elapsed_millis=3.305s
prefilling_size=8140852 prefilling_elapsed_millis=3.406s
prefilling_size=8230148 prefilling_elapsed_millis=3.506s
prefilling_size=8315116 prefilling_elapsed_millis=3.606s
prefilling_size=8394968 prefilling_elapsed_millis=3.706s
prefilling_size=8472092 prefilling_elapsed_millis=3.806s
prefilling_size=8544328 prefilling_elapsed_millis=3.907s
prefilling_size=8613610 prefilling_elapsed_millis=4.007s
prefilling_size=8679166 prefilling_elapsed_millis=4.107s
prefilling_size=8742218 prefilling_elapsed_millis=4.207s
prefilling_size=8801163 prefilling_elapsed_millis=4.307s
prefilling_size=8858623 prefilling_elapsed_millis=4.408s
prefilling_size=8914148 prefilling_elapsed_millis=4.508s
prefilling_size=8966211 prefilling_elapsed_millis=4.608s
prefilling_size=9015369 prefilling_elapsed_millis=4.708s
prefilling_size=9062527 prefilling_elapsed_millis=4.808s
prefilling_size=9108073 prefilling_elapsed_millis=4.909s
prefilling_size=9149801 prefilling_elapsed_millis=5.009s
Info: prefilling requires an additional insert phase to complete.
Info: prefilling using INSERTION ONLY.
timing_start inserting 850150 keys with 96 threads...
tid=0 thread_prefill_amount=108316 percent_done_estimate=1223.1 elapsed_s=5 est_remaining_s=-11 / -5
tid=0 thread_prefill_amount=110399 percent_done_estimate=1246.6 elapsed_s=5 est_remaining_s=-11 / -6
tid=0 thread_prefill_amount=112482 percent_done_estimate=1270.2 elapsed_s=5 est_remaining_s=-11 / -6
tid=0 thread_prefill_amount=114565 percent_done_estimate=1293.7 elapsed_s=5 est_remaining_s=-11 / -6
timing_elapsed 0.185781s
prefilling_size=10000000 prefilling_elapsed_millis=0.186s
finished prefilling to size 10000000 for expected size 10000000 keysum=99976839324744, performing 51603821 updates; total_prefilling_elapsed_ms=186 ms)
pref_size=10000000
pref_millis=186
prefill_elapsed_ms=186
main thread: starting timer...

###############################################################################
################################ BEGIN RUNNING ################################
###############################################################################

REALTIME_START_PERF_FORMAT=6993748.160165517
REALTIME_END_PERF_FORMAT=6993758.160248113

###############################################################################
################################## TIME IS UP #################################
###############################################################################

joining threads...
###############################################################################
################################# END RUNNING #################################
###############################################################################

10.1s
PRODUCING OUTPUT
computing tree_stats in PARALLEL...
bounded depth BFS to partition into subtrees for parallel computation (96 threads)...
partitioned into 512 subtrees; running parallel for...
computing stats for the top of the tree (above the partitions)...

tree_stats_computeWalltime=0.027s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262129 521835 985451 1488294 1397345 673052 138696 8568 44 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 15 2221 51085 400554 1229320 1551457 834610 175785 10673 49
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262144 524056 1036536 1888848 2626665 2224509 973306 184353 10717 49
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262144 524056 1036536 1888848 2626665 2224509 973306 184353 10717 49
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 1.99917 1.98215 1.87155 1.60268 1.31491 1.13498 1.04691 1.01166 1.00047 1

tree_stats_height=28
tree_stats_numInternals=5737557
tree_stats_numLeaves=4255769
tree_stats_numNodes=9993326
tree_stats_numKeys=9993326

tree_stats_avgDegreeInternal=1.74174
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.42586
tree_stats_avgKeyDepth=21.661


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:0
    [2^00, 2^01]: 0
sum_limbo_reclamation_event_size_total=
count_limbo_reclamation_event_size_by_thread=
count_limbo_reclamation_event_size_total=
sum_limbo_reclamation_event_count_total=318693
first_thread_announced_epoch_by_thread=7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852 7852
sum_num_inserts_by_thread=150874 151624 152854 152999 152678 151140 151556 152337 154322 154269 153283 152381 151159 152252 152884 154006 153188 152733 150346 152168 153411 153572 153298 152225 150863 151374 153036 153508 152604 151597 151065 152206 153284 154026 152880 152055 151531 152055 153226 153357 153498 152834 151136 152000 153235 154130 152975 151730 150331 151653 153079 153311 152952 151868 150656 152246 154213 153946 152565 151160 151816 152261 152836 154028 153306 150914 150180 150987 153437 153785 153034 152413 150022 152030 153038 153064 152498 152475 151608 151371 153620 154236 152930 152733 150844 151728 153109 153780 152424 151216 150754 151863 153244 152810 152221 152026
sum_num_inserts_total=14634385
sum_num_deletes_by_thread=150718 151286 153088 152788 152655 151356 152203 152159 153842 153627 153280 153372 151837 152736 153262 153632 154131 152364 150794 151964 153081 153598 153311 152602 151228 151442 152812 153079 153432 151542 151665 152759 153898 154106 153199 152487 151679 152632 153006 153811 153200 152366 150604 152492 152344 153473 153780 151574 150416 151684 152820 152833 152717 152285 150818 151840 153213 154128 153018 152250 151383 152887 152870 153518 153046 150786 150553 151043 153533 154081 152530 151542 149961 151917 152834 153684 152692 151585 150760 151646 153900 153460 152839 151743 151351 151854 152578 154037 152398 150500 150332 150638 152968 153779 152519 151914
sum_num_deletes_total=14633979
sum_num_searches_by_thread=2713901 2729129 2754235 2747124 2756198 2726547 2731932 2742977 2770539 2775614 2760719 2742668 2730644 2746120 2764252 2769606 2761612 2743468 2716266 2730018 2757362 2767160 2751188 2730049 2715633 2730278 2752509 2750806 2757687 2731309 2727203 2742935 2768032 2775244 2753068 2737853 2728287 2741008 2760892 2767289 2767142 2744328 2715505 2734994 2753873 2769832 2749579 2734283 2708840 2726442 2748045 2758335 2742679 2740172 2716520 2734233 2761509 2773274 2754395 2737289 2723090 2740595 2754184 2760262 2752950 2720269 2709015 2722162 2758053 2763901 2745761 2731520 2711058 2731702 2750332 2754807 2746579 2745563 2722986 2735958 2764609 2765660 2756266 2737785 2729215 2741804 2753986 2761426 2750196 2719145 2704694 2722704 2759488 2765436 2754040 2737295
sum_num_searches_total=263435126
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=3015493 3032039 3060177 3052911 3061531 3029043 3035691 3047473 3078703 3083510 3067282 3048421 3033640 3051108 3070398 3077244 3068931 3048565 3017406 3034150 3063854 3074330 3057797 3034876 3017724 3033094 3058357 3057393 3063723 3034448 3029933 3047900 3075214 3083376 3059147 3042395 3031497 3045695 3067124 3074457 3073840 3049528 3017245 3039486 3059452 3077435 3056334 3037587 3009587 3029779 3053944 3064479 3048348 3044325 3017994 3038319 3068935 3081348 3059978 3040699 3026289 3045743 3059890 3067808 3059302 3021969 3009748 3024192 3065023 3071767 3051325 3035475 3011041 3035649 3056204 3061555 3051769 3049623 3025354 3038975 3072129 3073356 3062035 3042261 3031410 3045386 3059673 3069243 3055018 3020861 3005780 3025205 3065700 3072025 3058780 3041235
average_num_operations_total=3048994
stdev_num_operations_total=1998
sum_num_operations_total=292703490
min_num_operations_total=3005780
max_num_operations_total=3083510
first_time_thread_terminate_by_thread=10000157 10000084 10000084 10000083 10000084 10000082 10000082 10000083 10000084 10000085 10000082 10000082 10000084 10000085 10000084 10000084 10000082 10000084 10000093 10000082 10000082 10000084 10000084 10000082 10000083 10000084 10000082 10000082 10000082 10000082 10000082 10000084 10000085 10000084 10000082 10000082 10000082 10000085 10000085 10000083 10000085 10000084 10000084 10000083 10000082 10000084 10000084 10000082 10000083 10000085 10000083 10000083 10000083 10000083 10000083 10000085 10000083 10000082 10000083 10000083 10000082 10000082 10000083 10000083 10000083 10000082 10000083 10000083 10000083 10000083 10000083 10000083 10000083 10000085 10000085 10000083 10000083 10000083 10000082 10000082 10000082 10000082 10000083 10000083 10000082 10000082 10000083 10000082 10000087 10000082 10000083 10000083 10000083 10000084 10000083 10000083
min_time_thread_terminate_total=10000082
max_time_thread_terminate_total=10000157
first_time_thread_start_by_thread=10 5 5 5 5 5 5 5 5 5 5 5 5 5 6 5 5 5 5 5 5 5 5 5 4 5 5 5 5 5 5 5 5 5 5 5 5 5 6 5 5 5 5 5 5 5 5 5 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 5 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 5
min_time_thread_start_total=4
max_time_thread_start_total=10
sum_duration_all_ops_total=

threads_final_keysum=99948446117185
threads_final_size=9993326
final_keysum=99948446117185
final_size=9993326
validate_result=success
Validation OK.
Structural validation OK.

total_find=263435126
total_rq=0
total_inserts=14634385
total_deletes=14633979
total_updates=29268364
total_queries=263435126
total_ops=292703490
find_throughput=26343512
rq_throughput=0
update_throughput=2926836
query_throughput=26343512
total_throughput=29270349


total find                    : 263435126
total rq                      : 0
total inserts                 : 14634385
total deletes                 : 14633979
total updates                 : 29268364
total queries                 : 263435126
total ops                     : 292703490
find throughput               : 26343512
rq throughput                 : 0
update throughput             : 2926836
query throughput              : 26343512
total throughput              : 29270349

elapsed milliseconds          : 10000
napping milliseconds overtime : 100

PAPI_L2_TCM=46.0698
PAPI_L3_TCM=8.59862
PAPI_TOT_CYC=7417.22
PAPI_TOT_INS=2413.49
garbage=1304255421022420
total_execution_walltime=15.641s
REALTIME_MAIN_END_PERF_FORMAT=6993758.315167580
TL2 system shutdown:
  GCLOCK=0x20C0A1A Starts=346895042 Aborts=4200985
  Overflows: R=0 W=0 L=0
[time_cmd_output] time_elapsed_sec=15.87, faults_major=0, faults_minor=695518, mem_maxresident_kb=1562540, user_cputime=1394.37, sys_cputime=86.03, percent_cpu=9326%
timeout=false
algorithm=brown_sigouin_int_avl_tm_auto.debra.tl2
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=1