__step=000281
__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 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 5.0 5.0 -k 2000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000281.txt
__path_data=data/data000281.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6998061.299292326
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=2000000
PREFILL_THREADS=48
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=48
WORK_THREADS=48
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


TL2 system ready: GV=GV4
Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.024s
prefilling_size=997168 prefilling_elapsed_millis=1.001s
finished prefilling to size 997153 for expected size 1000000 keysum=998301254971, performing 13509768 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=997153
pref_millis=1102
prefill_elapsed_ms=1117
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=6998062.594590102
REALTIME_END_PERF_FORMAT=6998072.594727188

###############################################################################
################################## 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.032s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16382 32749 64446 114675 151967 121541 48217 7359 268 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 0 2 14 940 12226 62554 139321 140618 60711 9247 336
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32763 65386 126901 214521 260862 188835 68070 9515 336
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32763 65386 126901 214521 260862 188835 68070 9515 336
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 2 2 1.99982 1.99615 1.95517 1.7868 1.50762 1.25797 1.10513 1.03167 1.00715 1

tree_stats_height=24
tree_stats_numInternals=573987
tree_stats_numLeaves=425969
tree_stats_numNodes=999956
tree_stats_numKeys=999956

tree_stats_avgDegreeInternal=1.74212
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.42599
tree_stats_avgKeyDepth=18.3627


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=487728
first_thread_announced_epoch_by_thread=21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586 21586
sum_num_inserts_by_thread=226956 227771 230741 232386 230841 228168 228019 229745 232322 234398 231985 229059 229195 229628 231441 231635 231583 230280 227232 229150 229936 232510 230555 227855 226795 229000 230589 231771 231611 228095 228001 229734 232306 233740 230569 229738 228808 229998 231709 232635 232676 229752 226254 229031 230824 231871 230650 228555
sum_num_inserts_total=11048103
sum_num_deletes_by_thread=227054 228928 229946 231922 230529 228079 227853 230166 233173 234425 231631 229185 228764 230438 232165 232271 231954 229650 227823 230004 230482 232732 231850 229054 227056 229792 230969 232275 231853 228138 229004 228299 233521 234593 230529 230000 227706 229919 232123 233465 232525 229598 226882 229266 230473 230894 230707 228191
sum_num_deletes_total=11057856
sum_num_searches_by_thread=4081598 4116299 4156308 4177981 4163213 4104983 4103992 4136869 4192204 4210852 4162667 4126717 4129785 4135939 4172423 4178699 4169493 4136424 4088695 4122418 4154278 4189151 4160105 4110794 4091440 4127273 4153937 4171815 4167046 4106355 4104076 4137337 4185351 4210745 4165957 4135894 4116180 4136762 4168084 4186809 4182210 4130432 4081717 4121052 4158058 4178953 4148508 4119501
sum_num_searches_total=198967379
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=4535608 4572998 4616995 4642289 4624583 4561230 4559864 4596780 4657699 4679675 4626283 4584961 4587744 4596005 4636029 4642605 4633030 4596354 4543750 4581572 4614696 4654393 4622510 4567703 4545291 4586065 4615495 4635861 4630510 4562588 4561081 4595370 4651178 4679078 4627055 4595632 4572694 4596679 4631916 4652909 4647411 4589782 4534853 4579349 4619355 4641718 4609865 4576247
average_num_operations_total=4605694
stdev_num_operations_total=5420
sum_num_operations_total=221073338
min_num_operations_total=4534853
max_num_operations_total=4679675
first_time_thread_terminate_by_thread=10000137 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136 10000136
min_time_thread_terminate_total=10000136
max_time_thread_terminate_total=10000137
first_time_thread_start_by_thread=3 3 3 3 4 3 3 3 4 3 3 4 3 3 3 3 3 3 3 3 3 3 3 4 3 3 3 3 3 3 3 3 4 3 3 4 3 3 3 3 3 3 3 3 3 3 3 4
min_time_thread_start_total=3
max_time_thread_start_total=4
sum_duration_all_ops_total=

threads_final_keysum=999507745454
threads_final_size=999956
final_keysum=999507745454
final_size=999956
validate_result=success
Validation OK.
Structural validation OK.

total_find=198967379
total_rq=0
total_inserts=11048103
total_deletes=11057856
total_updates=22105959
total_queries=198967379
total_ops=221073338
find_throughput=19896737
rq_throughput=0
update_throughput=2210595
query_throughput=19896737
total_throughput=22107333


total find                    : 198967379
total rq                      : 0
total inserts                 : 11048103
total deletes                 : 11057856
total updates                 : 22105959
total queries                 : 198967379
total ops                     : 221073338
find throughput               : 19896737
rq throughput                 : 0
update throughput             : 2210595
query throughput              : 19896737
total throughput              : 22107333

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=31.0738
PAPI_L3_TCM=2.74545
PAPI_TOT_CYC=4487.91
PAPI_TOT_INS=2139.4
garbage=95284703641729
total_execution_walltime=11.418s
REALTIME_MAIN_END_PERF_FORMAT=6998072.718134900
TL2 system shutdown:
  GCLOCK=0x1C580D0 Starts=235297374 Aborts=714267
  Overflows: R=0 W=0 L=0
[time_cmd_output] time_elapsed_sec=11.59, faults_major=0, faults_minor=303277, mem_maxresident_kb=763012, user_cputime=510.97, sys_cputime=51.58, percent_cpu=4853%
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