__step=000499
__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 200000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000499.txt
__path_data=data/data000499.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=7000823.860131809
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=200000
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.016s
prefilling_size=100164 prefilling_elapsed_millis=1.001s
finished prefilling to size 100178 for expected size 100000 keysum=10007916116, performing 11024775 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=100178
pref_millis=1102
prefill_elapsed_ms=1128
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=7000825.201362476
REALTIME_END_PERF_FORMAT=7000835.201515539

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

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

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

tree_stats_computeWalltime=0.031s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8088 14283 16543 8419 1571 64 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 99 1652 9704 18351 10541 1981 75
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8187 15935 26247 26770 12112 2045 75
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8187 15935 26247 26770 12112 2045 75
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 1.99878 1.95847 1.7508 1.38964 1.13795 1.03913 1.00538 1

tree_stats_height=20
tree_stats_numInternals=57159
tree_stats_numLeaves=42403
tree_stats_numNodes=99562
tree_stats_numKeys=99562

tree_stats_avgDegreeInternal=1.74184
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.4259
tree_stats_avgKeyDepth=14.9234


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=463008
first_thread_announced_epoch_by_thread=9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902 9902
sum_num_inserts_by_thread=216897 218544 220546 221214 220457 218464 217112 219711 221588 221579 220639 220132 218256 219816 220384 221476 220708 219885 217889 217786 220805 219940 220136 219586 217218 217762 219282 220671 219007 219311 218345 218744 220807 221630 218811 218640 219099 219261 220513 221230 220222 219993 216448 218173 220153 220554 220539 219472 196799 197072 198487 199633 198743 199386 197351 198807 199034 200165 199607 198314 196947 198457 199569 200544 199885 198368 196546 197784 198898 199723 198089 198722 197357 197974 199918 199483 199442 198702 197395 197326 200466 200562 199193 199185 196595 198943 199163 200102 200515 197857 196775 197203 200090 200796 199526 199758
sum_num_inserts_total=20080691
sum_num_deletes_by_thread=217046 218358 220805 221701 219527 219091 217958 219300 221011 222235 221361 220363 218563 220368 220093 221661 221247 219674 216808 217836 219730 221321 220259 219041 215989 217802 219989 221084 219786 218800 217333 218856 220015 220691 219474 219439 218396 219080 220379 221153 220473 218870 217256 217773 220253 220667 220236 219241 195465 197480 198138 199787 198609 199219 196689 197918 198737 199930 200251 198420 196037 198610 199492 200396 198628 197415 196408 198159 199144 199561 198671 198225 197576 198587 198941 200501 200362 197920 197376 198051 199519 200156 199368 198404 196864 198730 199014 201546 200408 197082 196874 197669 200474 200759 199968 199052
sum_num_deletes_total=20074982
sum_num_searches_by_thread=3898300 3932231 3970714 3984119 3967420 3940299 3918694 3941537 3988194 4000971 3972292 3958274 3939790 3956147 3972264 3990678 3980974 3952957 3910536 3931008 3949216 3979956 3959165 3937524 3898307 3919329 3950617 3968818 3954089 3928364 3916869 3933423 3974887 3989496 3950668 3953984 3940811 3946396 3967262 3982122 3973283 3948927 3896923 3927032 3966977 3967662 3966199 3936669 3536486 3559866 3575611 3589624 3581082 3578173 3546802 3562896 3583564 3600742 3605801 3570944 3549986 3576246 3595292 3605673 3587301 3556662 3534168 3556394 3582005 3599308 3582725 3573250 3551455 3564599 3588946 3605463 3593103 3576668 3553307 3556680 3593575 3610735 3591589 3575198 3542938 3573529 3580667 3606999 3594840 3558570 3549132 3556184 3606364 3618193 3599094 3592118
sum_num_searches_total=361422921
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=4332243 4369133 4412065 4427034 4407404 4377854 4353764 4380548 4430793 4444785 4414292 4398769 4376609 4396331 4412741 4433815 4422929 4392516 4345233 4366630 4389751 4421217 4399560 4376151 4331514 4354893 4389888 4410573 4392882 4366475 4352547 4371023 4415709 4431817 4388953 4392063 4378306 4384737 4408154 4424505 4413978 4387790 4330627 4362978 4407383 4408883 4406974 4375382 3928750 3954418 3972236 3989044 3978434 3976778 3940842 3959621 3981335 4000837 4005659 3967678 3942970 3973313 3994353 4006613 3985814 3952445 3927122 3952337 3980047 3998592 3979485 3970197 3946388 3961160 3987805 4005447 3992907 3973290 3948078 3952057 3993560 4011453 3990150 3972787 3936397 3971202 3978844 4008647 3995763 3953509 3942781 3951056 4006928 4019748 3998588 3990928
average_num_operations_total=4183110
stdev_num_operations_total=21612
sum_num_operations_total=401578594
min_num_operations_total=3927122
max_num_operations_total=4444785
first_time_thread_terminate_by_thread=10000155 10000155 10000154 10000154 10000153 10000153 10000155 10000155 10000155 10000154 10000154 10000155 10000153 10000156 10000153 10000153 10000156 10000153 10000154 10000154 10000153 10000155 10000155 10000154 10000155 10000153 10000153 10000154 10000154 10000155 10000155 10000153 10000155 10000154 10000153 10000153 10000153 10000156 10000153 10000154 10000157 10000153 10000154 10000154 10000153 10000155 10000155 10000154 10000156 10000155 10000155 10000153 10000154 10000153 10000153 10000153 10000156 10000153 10000155 10000154 10000154 10000153 10000153 10000154 10000154 10000158 10000156 10000153 10000153 10000153 10000155 10000153 10000158 10000155 10000155 10000153 10000154 10000156 10000156 10000153 10000153 10000155 10000153 10000156 10000156 10000153 10000153 10000154 10000156 10000156 10000153 10000153 10000153 10000154 10000154 10000153
min_time_thread_terminate_total=10000153
max_time_thread_terminate_total=10000158
first_time_thread_start_by_thread=3 3 3 3 3 3 3 3 3 3 2 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 2 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3
min_time_thread_start_total=2
max_time_thread_start_total=3
sum_duration_all_ops_total=

threads_final_keysum=9930741124
threads_final_size=99562
final_keysum=9930741124
final_size=99562
validate_result=success
Validation OK.
Structural validation OK.

total_find=361422921
total_rq=0
total_inserts=20080691
total_deletes=20074982
total_updates=40155673
total_queries=361422921
total_ops=401578594
find_throughput=36142292
rq_throughput=0
update_throughput=4015567
query_throughput=36142292
total_throughput=40157859


total find                    : 361422921
total rq                      : 0
total inserts                 : 20080691
total deletes                 : 20074982
total updates                 : 40155673
total queries                 : 361422921
total ops                     : 401578594
find throughput               : 36142292
rq throughput                 : 0
update throughput             : 4015567
query throughput              : 36142292
total throughput              : 40157859

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=20.4741
PAPI_L3_TCM=0.82573
PAPI_TOT_CYC=4597.51
PAPI_TOT_INS=1873
garbage=17895184685080
total_execution_walltime=11.43s
REALTIME_MAIN_END_PERF_FORMAT=7000835.290941247
TL2 system shutdown:
  GCLOCK=0x179FE02 Starts=416742229 Aborts=4138859
  Overflows: R=0 W=0 L=0
[time_cmd_output] time_elapsed_sec=11.61, faults_major=0, faults_minor=391209, mem_maxresident_kb=944324, user_cputime=998.25, sys_cputime=95.20, percent_cpu=9414%
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