__step=000761
__cmd_run=LD_PRELOAD=../../setbench/lib/libjemalloc.so timeout 60 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" ./bronson_pext_bst_occ.debra -nwork 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 50.0 50.0 -k 20000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000761.txt
__path_data=data/data000761.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6988140.232338278
binary=./bronson_pext_bst_occ.debra
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=bronson_pext_bst_occ
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=50
DEL_FRAC=50
RQ=0
RQSIZE=0
MAXKEY=20000000
PREFILL_THREADS=48
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=48
WORK_THREADS=48
RQ_THREADS=0
distribution=0
INS_DEL_FRAC=50.0 50.0
PREFILL_TYPE=PREFILL_HYBRID
PREFILL_HYBRID_MIN_MS=1000
PREFILL_HYBRID_MAX_MS=5000
sizes: node=56
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


Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.006s
prefilling_size=7390017 prefilling_elapsed_millis=1.001s
prefilling_size=7678819 prefilling_elapsed_millis=1.101s
prefilling_size=7933799 prefilling_elapsed_millis=1.201s
prefilling_size=8161802 prefilling_elapsed_millis=1.301s
prefilling_size=8360405 prefilling_elapsed_millis=1.402s
prefilling_size=8540534 prefilling_elapsed_millis=1.502s
prefilling_size=8700199 prefilling_elapsed_millis=1.602s
prefilling_size=8841503 prefilling_elapsed_millis=1.702s
prefilling_size=8968791 prefilling_elapsed_millis=1.802s
prefilling_size=9079296 prefilling_elapsed_millis=1.903s
prefilling_size=9177486 prefilling_elapsed_millis=2.003s
prefilling_size=9267304 prefilling_elapsed_millis=2.103s
prefilling_size=9345256 prefilling_elapsed_millis=2.203s
prefilling_size=9416168 prefilling_elapsed_millis=2.303s
prefilling_size=9479232 prefilling_elapsed_millis=2.404s
prefilling_size=9533288 prefilling_elapsed_millis=2.504s
prefilling_size=9582799 prefilling_elapsed_millis=2.604s
prefilling_size=9626891 prefilling_elapsed_millis=2.704s
prefilling_size=9668641 prefilling_elapsed_millis=2.804s
prefilling_size=9706499 prefilling_elapsed_millis=2.905s
prefilling_size=9738660 prefilling_elapsed_millis=3.005s
prefilling_size=9766064 prefilling_elapsed_millis=3.105s
prefilling_size=9791793 prefilling_elapsed_millis=3.205s
prefilling_size=9814964 prefilling_elapsed_millis=3.305s
finished prefilling to size 9814949 for expected size 10000000 keysum=98153949460559, performing 79759151 updates; total_prefilling_elapsed_ms=3406 ms)
pref_size=9814949
pref_millis=3406
prefill_elapsed_ms=3430
6node_tIxPvE_object_size=56
6node_tIxPvE_allocated_count=0
6node_tIxPvE_allocated_size=0MB
6node_tIxPvE_get_from_pool=0
6node_tIxPvE_deallocated=0
6node_tIxPvE_limbo_count=0
6node_tIxPvE_limbo_details=0 0 0 

global_epoch_counter=3617

main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=6988143.834171342
REALTIME_END_PERF_FORMAT=6988153.834312483

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

tree_stats_numInternalsAtDepth=1 1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262130 522895 1008482 1650047 1811667 1053432 264071 21617 271 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 14 1293 33483 313303 1203678 1957924 1322183 343556 27657 350
tree_stats_numNodesAtDepth=1 1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262144 524188 1041965 1963350 3015345 3011356 1586254 365173 27928 350
tree_stats_numKeysAtDepth=0 0 0 3 3 7 13 41 59 136 250 505 1048 2060 4093 8260 16318 32888 65720 132923 278398 627099 1432981 2600048 2847139 1558435 363664 27909 350
tree_stats_avgDegreeAtDepth=1 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 1.99967 1.99024 1.91641 1.69538 1.39784 1.17691 1.06372 1.01725 1.00279 1

tree_stats_height=29
tree_stats_numInternals=6856756
tree_stats_numLeaves=5203441
tree_stats_numNodes=12060197
tree_stats_numKeys=10000350

tree_stats_avgDegreeInternal=1.75888
tree_stats_avgDegreeLeaves=0.999962
tree_stats_avgDegree=1.43144
tree_stats_avgKeyDepth=23.2326

tree_stats_bytesAtDepth=56 56 112 224 448 896 1792 3584 7168 14336 28672 57344 114688 229376 458752 917504 1835008 3670016 7340032 14680064 29354528 58350040 109947600 168859320 168635936 88830224 20449688 1563968 19600
tree_stats_sizeInBytes=675371032

6node_tIxPvE_object_size=56
6node_tIxPvE_allocated_count=0
6node_tIxPvE_allocated_size=0MB
6node_tIxPvE_get_from_pool=0
6node_tIxPvE_deallocated=0
6node_tIxPvE_limbo_count=0
6node_tIxPvE_limbo_details=0 0 0 

global_epoch_counter=13791


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:1 2:0 4:0 8:3 16:19 32:1159 64:478386 128:194 256:95 512:47
    [2^00, 2^01]: 1
    (2^01, 2^02]: 0
    (2^02, 2^03]: 0
    (2^03, 2^04]: 3
    (2^04, 2^05]: 19
    (2^05, 2^06]: 1159
    (2^06, 2^07]: 478386
    (2^07, 2^08]: 194
    (2^08, 2^09]: 95
    (2^09, 2^10]: 47
sum_limbo_reclamation_event_size_total=43253305
count_limbo_reclamation_event_size_by_thread=9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998
count_limbo_reclamation_event_size_total=479904
sum_limbo_reclamation_event_count_total=488352
first_thread_announced_epoch_by_thread=27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582 27582
sum_num_inserts_by_thread=2300346 2313112 2343937 2342762 2319224 2296445 2323435 2316428 2336006 2355323 2312366 2292187 2314843 2336828 2348131 2347734 2319679 2304491 2300395 2312287 2311690 2327835 2321484 2307990 2303864 2325481 2337898 2332733 2310520 2297847 2322453 2331209 2349819 2349606 2295585 2284803 2301716 2320192 2344238 2342482 2315635 2300693 2306980 2306637 2336758 2347736 2321678 2287107
sum_num_inserts_total=111378628
sum_num_deletes_by_thread=2303132 2312679 2346479 2345187 2321874 2296925 2321647 2316226 2338554 2356474 2311315 2288969 2317260 2334726 2351093 2352024 2320081 2307079 2301419 2310501 2312918 2328411 2319728 2302439 2306970 2323994 2334800 2335494 2312923 2300543 2319935 2331399 2350598 2349305 2295359 2284628 2301467 2317312 2348610 2343535 2314981 2301835 2306705 2306724 2337454 2344194 2321052 2287976
sum_num_deletes_total=111394933
sum_num_searches_by_thread=
sum_num_searches_total=
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=4603478 4625791 4690416 4687949 4641098 4593370 4645082 4632654 4674560 4711797 4623681 4581156 4632103 4671554 4699224 4699758 4639760 4611570 4601814 4622788 4624608 4656246 4641212 4610429 4610834 4649475 4672698 4668227 4623443 4598390 4642388 4662608 4700417 4698911 4590944 4569431 4603183 4637504 4692848 4686017 4630616 4602528 4613685 4613361 4674212 4691930 4642730 4575083
average_num_operations_total=4641115
stdev_num_operations_total=5540
sum_num_operations_total=222773561
min_num_operations_total=4569431
max_num_operations_total=4711797
first_time_thread_terminate_by_thread=10000139 10000139 10000139 10000139 10000139 10000139 10000140 10000139 10000139 10000139 10000139 10000139 10000140 10000139 10000140 10000139 10000139 10000140 10000140 10000140 10000139 10000140 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000139 10000140 10000139 10000140 10000139 10000139 10000139
min_time_thread_terminate_total=10000139
max_time_thread_terminate_total=10000140
first_time_thread_start_by_thread=6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6
min_time_thread_start_total=6
max_time_thread_start_total=6
sum_duration_all_ops_total=

threads_final_keysum=100004356626455
threads_final_size=10000350
final_keysum=100004356626455
final_size=10000350
validate_result=success
Validation OK.
Structural validation OK.

total_find=0
total_rq=0
total_inserts=111378628
total_deletes=111394933
total_updates=222773561
total_queries=0
total_ops=222773561
find_throughput=0
rq_throughput=0
update_throughput=22277356
query_throughput=0
total_throughput=22277356


total find                    : 0
total rq                      : 0
total inserts                 : 111378628
total deletes                 : 111394933
total updates                 : 222773561
total queries                 : 0
total ops                     : 222773561
find throughput               : 0
rq throughput                 : 0
update throughput             : 22277356
query throughput              : 0
total throughput              : 22277356

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=34.2907
PAPI_L3_TCM=12.1621
PAPI_TOT_CYC=6005.86
PAPI_TOT_INS=1976.57
garbage=0
total_execution_walltime=13.743s
REALTIME_MAIN_END_PERF_FORMAT=6988153.976240397
[time_cmd_output] time_elapsed_sec=13.92, faults_major=0, faults_minor=270242, mem_maxresident_kb=1082872, user_cputime=672.74, sys_cputime=2.98, percent_cpu=4852%
timeout=false
algorithm=bronson_pext_bst_occ.debra
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=1