__step=000274
__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" ./natarajan_ext_bst_lf.debra -nwork 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 0.5 0.5 -k 200000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000274.txt
__path_data=data/data000274.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6982084.265023737
binary=./natarajan_ext_bst_lf.debra
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=natarajan_ext_bst_lf
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=0.5
DEL_FRAC=0.5
RQ=0
RQSIZE=0
MAXKEY=200000
PREFILL_THREADS=48
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=48
WORK_THREADS=48
RQ_THREADS=0
distribution=0
INS_DEL_FRAC=0.5 0.5
PREFILL_TYPE=PREFILL_HYBRID
PREFILL_HYBRID_MIN_MS=1000
PREFILL_HYBRID_MAX_MS=5000
sizes: node=32
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=100384 prefilling_elapsed_millis=1.001s
finished prefilling to size 100385 for expected size 100000 keysum=10035045760, performing 66112396 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=100385
pref_millis=1102
prefill_elapsed_ms=1124
6node_tIxPvE_object_size=32
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=3319
main thread: starting timer...
###############################################################################
################################ BEGIN RUNNING ################################
###############################################################################
REALTIME_START_PERF_FORMAT=6982085.534527790
REALTIME_END_PERF_FORMAT=6982095.534684704
###############################################################################
################################## 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 904 subtrees; running parallel for...
computing stats for the top of the tree (above the partitions)...
tree_stats_computeWalltime=0.037s
tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 246 452 788 1293 2049 3157 4568 6252 7858 9017 9712 9710 9172 8256 7080 5731 4553 3344 2403 1631 1080 661 411 261 164 93 46 21 12 5 1 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 10 40 116 283 537 941 1746 2884 4646 6699 8322 9714 10248 10088 9432 8429 6909 5762 4285 3175 2182 1499 911 561 358 235 140 71 30 19 9 2
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 492 904 1576 2586 4098 6314 9136 12504 15716 18034 19424 19420 18344 16512 14160 11462 9106 6688 4806 3262 2160 1322 822 522 328 186 92 42 24 10 2
tree_stats_numKeysAtDepth=0 0 0 0 0 0 0 0 10 40 116 283 537 941 1746 2884 4646 6699 8322 9714 10248 10088 9432 8429 6909 5762 4285 3175 2182 1499 911 561 358 235 140 71 30 19 9 2
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 1.96094 1.9187 1.87168 1.82043 1.79234 1.77038 1.72347 1.68433 1.62844 1.57375 1.53854 1.4999 1.4723 1.45007 1.42878 1.40473 1.39723 1.36723 1.3593 1.33937 1.33109 1.30602 1.31089 1.31752 1.31418 1.28354 1.24731 1.22826 1.28571 1.20833 1.1 1
tree_stats_height=40
tree_stats_numInternals=100282
tree_stats_numLeaves=100283
tree_stats_numNodes=200565
tree_stats_numKeys=100283
tree_stats_avgDegreeInternal=2.00001
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.5
tree_stats_avgKeyDepth=21.1083
tree_stats_bytesAtDepth=32 64 128 256 512 1024 2048 4096 8192 15744 28928 50432 82752 131136 202048 292352 400128 502912 577088 621568 621440 587008 528384 453120 366784 291392 214016 153792 104384 69120 42304 26304 16704 10496 5952 2944 1344 768 320 64
tree_stats_sizeInBytes=6418080
6node_tIxPvE_object_size=32
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=49980
log_histogram_of_none_limbo_reclamation_event_size_full_data=1:0 2:175545 4:139509 8:14397 16:13
(2^01, 2^02]: 175545
(2^02, 2^03]: 139509
(2^03, 2^04]: 14397
(2^04, 2^05]: 13
sum_limbo_reclamation_event_size_total=1110014
count_limbo_reclamation_event_size_by_thread=6899 6821 6943 6908 6829 6768 6757 6823 6875 6945 6823 6941 6851 6902 6877 6972 6867 6800 6833 6801 6933 6951 6819 6891 6761 6776 6865 6837 6809 6838 6822 6862 6819 6908 6852 6860 6778 6920 6917 6900 6861 6941 6806 6878 6908 6954 6861 6902
count_limbo_reclamation_event_size_total=329464
sum_limbo_reclamation_event_count_total=2239728
first_thread_announced_epoch_by_thread=99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960 99960
sum_num_inserts_by_thread=106812 108090 108500 107069 107906 106523 106378 107409 109513 109625 108144 107463 106808 107936 108089 109504 108626 108616 106993 107864 109241 109372 107413 106003 106386 107601 108170 108160 108566 106627 106298 106997 108388 109067 107664 107618 108054 108527 109466 108914 108172 107764 106897 107867 109311 109061 107788 107572
sum_num_inserts_total=5180832
sum_num_deletes_by_thread=106844 106856 108523 107036 107599 106181 106218 107980 109227 110320 108159 107917 106857 108042 108231 109575 108488 108064 107199 107921 109144 109747 107337 107014 106558 107287 108089 108220 107214 106311 106668 106858 107959 108853 107610 107660 107221 107892 108435 109130 108736 108270 106947 107652 109075 109790 107847 107264
sum_num_deletes_total=5178025
sum_num_searches_by_thread=21089855 21253386 21466567 21250421 21271954 20965301 21101451 21313498 21636090 21711553 21392669 21246463 21155497 21397023 21521666 21651391 21551106 21404537 21219717 21364924 21595718 21636922 21284229 21143859 21092277 21314620 21444776 21444491 21311281 21017630 21157799 21254047 21536244 21645597 21355908 21263445 21321186 21396680 21588328 21614933 21432461 21345797 21131949 21330236 21569714 21666887 21407806 21161391
sum_num_searches_total=1025431280
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=21303511 21468332 21683590 21464526 21487459 21178005 21314047 21528887 21854830 21931498 21608972 21461843 21369162 21613001 21737986 21870470 21768220 21621217 21433909 21580709 21814103 21856041 21498979 21356876 21305221 21529508 21661035 21660871 21527061 21230568 21370765 21467902 21752591 21863517 21571182 21478723 21536461 21613099 21806229 21832977 21649369 21561831 21345793 21545755 21788100 21885738 21623441 21376227
average_num_operations_total=21578961
stdev_num_operations_total=27932
sum_num_operations_total=1035790137
min_num_operations_total=21178005
max_num_operations_total=21931498
first_time_thread_terminate_by_thread=10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000155 10000156 10000155 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000155 10000156 10000155 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156 10000156
min_time_thread_terminate_total=10000155
max_time_thread_terminate_total=10000156
first_time_thread_start_by_thread=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 2 3 3
min_time_thread_start_total=2
max_time_thread_start_total=3
sum_duration_all_ops_total=
threads_final_keysum=10052338854
threads_final_size=100283
final_keysum=10052338854
final_size=100283
validate_result=success
Validation OK.
Structural validation OK.
total_find=1025431280
total_rq=0
total_inserts=5180832
total_deletes=5178025
total_updates=10358857
total_queries=1025431280
total_ops=1035790137
find_throughput=102543128
rq_throughput=0
update_throughput=1035885
query_throughput=102543128
total_throughput=103579013
total find : 1025431280
total rq : 0
total inserts : 5180832
total deletes : 5178025
total updates : 10358857
total queries : 1025431280
total ops : 1035790137
find throughput : 102543128
rq throughput : 0
update throughput : 1035885
query throughput : 102543128
total throughput : 103579013
elapsed milliseconds : 10000
napping milliseconds overtime : 0
PAPI_L2_TCM=4.91155
PAPI_L3_TCM=0.000145808
PAPI_TOT_CYC=1273.03
PAPI_TOT_INS=296.056
garbage=51295607136894
total_execution_walltime=11.403s
REALTIME_MAIN_END_PERF_FORMAT=6982095.669509195
[time_cmd_output] time_elapsed_sec=11.53, faults_major=0, faults_minor=78490, mem_maxresident_kb=315264, user_cputime=563.01, sys_cputime=2.93, percent_cpu=4907%
timeout=false
algorithm=natarajan_ext_bst_lf.debra
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=2