__step=000148
__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" ./ellen_ext_bst_lf.debra -nwork 96 -nprefill 96 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 0.5 0.5 -k 2000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000148.txt
__path_data=data/data000148.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6980608.236993006
binary=./ellen_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=ellen_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=2000000
PREFILL_THREADS=96
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=96
WORK_THREADS=96
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=40 descriptor=64
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
Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.024s
prefilling_size=999221 prefilling_elapsed_millis=1.001s
finished prefilling to size 999266 for expected size 1000000 keysum=999404841478, performing 32864828 updates; total_prefilling_elapsed_ms=1103 ms)
pref_size=999266
pref_millis=1103
prefill_elapsed_ms=1123
6node_tIxPvE_object_size=40
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=559
6info_tIxPvE_object_size=64
6info_tIxPvE_allocated_count=0
6info_tIxPvE_allocated_size=0MB
6info_tIxPvE_get_from_pool=0
6info_tIxPvE_deallocated=0
6info_tIxPvE_limbo_count=0
6info_tIxPvE_limbo_details=0 0 0
global_epoch_counter=0
main thread: starting timer...
###############################################################################
################################ BEGIN RUNNING ################################
###############################################################################
REALTIME_START_PERF_FORMAT=6980609.548659567
REALTIME_END_PERF_FORMAT=6980619.548819548
###############################################################################
################################## 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 982 subtrees; running parallel for...
computing stats for the top of the tree (above the partitions)...
tree_stats_computeWalltime=0.042s
tree_stats_numInternalsAtDepth=1 1 1 2 4 8 16 32 64 128 254 491 936 1689 3004 5037 8043 12348 18318 26198 35992 47467 59360 70416 78648 83714 85807 83795 77687 69163 58908 48178 37958 28382 20644 14319 9220 5804 3529 1994 1037 552 268 121 48 15 5 0
tree_stats_numLeavesAtDepth=0 1 1 0 0 0 0 0 0 0 2 17 46 183 374 971 2031 3738 6378 10438 16404 24517 35574 48304 62184 73582 81621 87819 89903 86211 79418 69638 58398 47534 36120 26969 19418 12636 8079 5064 2951 1522 836 415 194 81 25 10
tree_stats_numNodesAtDepth=1 2 2 2 4 8 16 32 64 128 256 508 982 1872 3378 6008 10074 16086 24696 36636 52396 71984 94934 118720 140832 157296 167428 171614 167590 155374 138326 117816 96356 75916 56764 41288 28638 18440 11608 7058 3988 2074 1104 536 242 96 30 10
tree_stats_numKeysAtDepth=0 0 0 0 0 0 0 0 0 0 2 17 46 183 374 971 2031 3738 6378 10438 16404 24517 35574 48304 62184 73582 81621 87819 89903 86211 79418 69638 58398 47534 36120 26969 19418 12636 8079 5064 2951 1522 836 415 194 81 25 10
tree_stats_avgDegreeAtDepth=2 1 1 2 2 2 2 2 2 2 1.99219 1.96654 1.95316 1.90224 1.88928 1.83838 1.79839 1.76762 1.74174 1.71509 1.68692 1.65941 1.62528 1.59313 1.55845 1.53221 1.5125 1.48828 1.46355 1.44514 1.42586 1.40893 1.39393 1.37386 1.36368 1.34681 1.32195 1.31475 1.30401 1.28252 1.26003 1.26615 1.24275 1.22575 1.19835 1.15625 1.16667 1
tree_stats_height=48
tree_stats_numInternals=999606
tree_stats_numLeaves=999607
tree_stats_numNodes=1999213
tree_stats_numKeys=999605
tree_stats_avgDegreeInternal=2
tree_stats_avgDegreeLeaves=0.999998
tree_stats_avgDegree=1.5
tree_stats_avgKeyDepth=28.0913
tree_stats_bytesAtDepth=40 80 80 80 160 320 640 1280 2560 5120 10240 20320 39280 74880 135120 240320 402960 643440 987840 1465440 2095840 2879360 3797360 4748800 5633280 6291840 6697120 6864560 6703600 6214960 5533040 4712640 3854240 3036640 2270560 1651520 1145520 737600 464320 282320 159520 82960 44160 21440 9680 3840 1200 400
tree_stats_sizeInBytes=79968520
6node_tIxPvE_object_size=40
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=10063
6info_tIxPvE_object_size=64
6info_tIxPvE_allocated_count=0
6info_tIxPvE_allocated_size=0MB
6info_tIxPvE_get_from_pool=0
6info_tIxPvE_deallocated=0
6info_tIxPvE_limbo_count=0
6info_tIxPvE_limbo_details=0 0 0
global_epoch_counter=0
log_histogram_of_none_limbo_reclamation_event_size_full_data=1:31456 2:183706 4:494608 8:233966 16:6710 32:113 64:3
[2^00, 2^01]: 31456
(2^01, 2^02]: 183706
(2^02, 2^03]: 494608
(2^03, 2^04]: 233966
(2^04, 2^05]: 6710
(2^05, 2^06]: 113
(2^06, 2^07]: 3
sum_limbo_reclamation_event_size_total=5575908
count_limbo_reclamation_event_size_by_thread=9914 9888 9906 9906 9902 9898 9888 9906 9906 9882 9898 9864 9906 9892 9872 9902 9886 9926 9912 9910 9918 9926 9914 9912 9910 9896 9872 9908 9900 9912 9924 9906 9910 9900 9902 9884 9900 9892 9898 9892 9912 9900 9874 9894 9906 9908 9870 9888 9906 9932 9906 9912 9888 9912 9904 9892 9888 9918 9894 9866 9884 9904 9908 9914 9900 9896 9914 9924 9906 9934 9886 9902 9890 9900 9888 9904 9886 9890 9900 9902 9914 9922 9914 9884 9894 9890 9902 9920 9938 9886 9890 9914 9910 9906 9934 9902
count_limbo_reclamation_event_size_total=950562
sum_limbo_reclamation_event_count_total=1824768
first_thread_announced_epoch_by_thread=20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126 20126
sum_num_inserts_by_thread=44318 44376 44743 44240 44159 43422 43842 44109 44394 44914 44617 43900 44193 44603 44709 44976 44211 43772 43767 44137 44847 44550 43834 43729 44050 44052 44575 44801 44334 43732 44167 43987 45245 44858 44238 43990 44124 44711 44773 44598 44136 43836 43529 43939 44411 44421 43861 43619 43698 43934 44462 44648 43866 43775 43763 43972 44669 44786 43847 43796 44155 44261 45006 44874 43949 43527 43660 44069 44226 44382 44105 43993 43122 44106 44781 44460 43825 43728 43513 43872 44722 44984 44818 43819 44405 44382 44716 45038 44156 43965 43536 44014 44405 44504 44577 43772
sum_num_inserts_total=4244992
sum_num_deletes_by_thread=44067 44209 44680 44788 44432 43896 43888 44197 44678 45043 44223 43609 44205 44432 44647 44705 43997 44478 43994 43940 44308 44650 43517 43490 43854 43802 44446 44888 44565 43559 44019 44419 44723 44708 44652 44017 44378 44223 44599 44542 44091 43852 43506 43864 44008 44561 44125 43116 43521 44043 44872 44816 44141 43627 43781 44345 44860 44483 44566 44429 43996 44525 44778 44825 44249 43825 43441 44204 44126 44904 43805 43878 43464 44221 44408 44205 43701 43508 43618 44015 45197 45199 44551 44103 43687 44284 44413 44591 44556 43095 43695 44069 44345 44187 44764 43936
sum_num_deletes_total=4244442
sum_num_searches_by_thread=8684211 8733960 8820439 8824713 8769422 8660276 8711277 8756061 8839603 8876612 8770237 8706688 8736069 8782652 8835489 8853418 8796492 8725097 8643925 8727446 8798112 8858566 8701369 8641733 8655814 8721006 8829896 8833446 8793698 8664284 8722387 8760602 8868475 8883883 8761177 8702658 8723258 8778848 8842629 8846340 8756810 8694031 8604706 8701101 8768907 8809209 8692113 8559281 8615737 8702333 8815547 8813868 8734880 8689626 8692058 8754577 8851966 8882585 8778613 8713050 8722635 8794240 8859692 8861511 8761801 8660419 8609087 8705773 8818137 8818772 8727014 8664758 8632693 8700688 8810425 8810312 8731197 8657545 8665124 8724608 8855196 8869960 8787369 8718151 8721879 8793524 8840055 8851391 8762771 8663600 8624452 8710131 8834224 8843578 8769958 8695452
sum_num_searches_total=840351388
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=8772596 8822545 8909862 8913741 8858013 8747594 8799007 8844367 8928675 8966569 8859077 8794197 8824467 8871687 8924845 8943099 8884700 8813347 8731686 8815523 8887267 8947766 8788720 8728952 8743718 8808860 8918917 8923135 8882597 8751575 8810573 8849008 8958443 8973449 8850067 8790665 8811760 8867782 8932001 8935480 8845037 8781719 8691741 8788904 8857326 8898191 8780099 8646016 8702956 8790310 8904881 8903332 8822887 8777028 8779602 8842894 8941495 8971854 8867026 8801275 8810786 8883026 8949476 8951210 8849999 8747771 8696188 8794046 8906489 8908058 8814924 8752629 8719279 8789015 8899614 8898977 8818723 8744781 8752255 8812495 8945115 8960143 8876738 8806073 8809971 8882190 8929184 8941020 8851483 8750660 8711683 8798214 8922974 8932269 8859299 8783160
average_num_operations_total=8842091
stdev_num_operations_total=7837
sum_num_operations_total=848840822
min_num_operations_total=8646016
max_num_operations_total=8973449
first_time_thread_terminate_by_thread=10000160 10000160 10000160 10000159 10000160 10000160 10000159 10000160 10000160 10000160 10000160 10000160 10000159 10000159 10000160 10000159 10000160 10000160 10000159 10000160 10000160 10000159 10000159 10000159 10000160 10000160 10000160 10000159 10000160 10000160 10000159 10000160 10000160 10000160 10000160 10000160 10000159 10000159 10000160 10000159 10000159 10000160 10000159 10000160 10000160 10000159 10000159 10000159 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160 10000160
min_time_thread_terminate_total=10000159
max_time_thread_terminate_total=10000160
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 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 13 3 13 3 3 13 3 3 13 13 3 13 13 3 13 3 3 13 3 13 3 3 3 3 13 3 13 3 3 13 3 3 13 13 3 13 13 3 13 3 3 13 3 13 3 3 3
min_time_thread_start_total=3
max_time_thread_start_total=13
sum_duration_all_ops_total=
threads_final_keysum=999231862959
threads_final_size=999605
final_keysum=999231862959
final_size=999605
validate_result=success
Validation OK.
Structural validation OK.
total_find=840351388
total_rq=0
total_inserts=4244992
total_deletes=4244442
total_updates=8489434
total_queries=840351388
total_ops=848840822
find_throughput=84035138
rq_throughput=0
update_throughput=848943
query_throughput=84035138
total_throughput=84884082
total find : 840351388
total rq : 0
total inserts : 4244992
total deletes : 4244442
total updates : 8489434
total queries : 840351388
total ops : 848840822
find throughput : 84035138
rq throughput : 0
update throughput : 848943
query throughput : 84035138
total throughput : 84884082
elapsed milliseconds : 10000
napping milliseconds overtime : 0
PAPI_L2_TCM=21.9578
PAPI_L3_TCM=4.82601
PAPI_TOT_CYC=3147.7
PAPI_TOT_INS=343.624
garbage=420124342624062
total_execution_walltime=11.483s
REALTIME_MAIN_END_PERF_FORMAT=6980619.721503549
[time_cmd_output] time_elapsed_sec=11.61, faults_major=0, faults_minor=105575, mem_maxresident_kb=420012, user_cputime=1093.55, sys_cputime=2.58, percent_cpu=9437%
timeout=false
algorithm=ellen_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