__step=000170
__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" ./sigouin_int_bst_kcas_validate.debra -nwork 64 -nprefill 64 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 5.0 5.0 -k 2000000 -t 10000 -pin 0-63,128-191,64-127,192-255
__file_data=data000170.txt
__path_data=data/data000170.txt
__hostname=nasus
sizeof(kcasdesc_t)=2304
sizeof(rdcssdesc_t)=192
addrof(kcasDescriptors[0])=0x55670120d3c0
addrof(kcasDescriptors[1])=0x55670120dcc0
addrof(rdcssDescriptors[0])=0x55670132d3c0
addrof(rdcssDescriptors[1])=0x55670132d480
sizeof(validationSet)=1608
REALTIME_MAIN_START_PERF_FORMAT=221941.719001688
binary=./sigouin_int_bst_kcas_validate.debra
parsed custom binding: 0-63,128-191,64-127,192-255
DS_TYPENAME=sigouin_int_bst_kcas_validate
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=64
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=64
WORK_THREADS=64
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=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,24,25,26,27,28,29,30,31,32,33,34,35,36,37,38,39,40,41,42,43,44,45,46,47,48,49,50,51,52,53,54,55,56,57,58,59,60,61,62,63


Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.019s
prefilling_size=999961 prefilling_elapsed_millis=1s
finished prefilling to size 999912 for expected size 1000000 keysum=999546019601, performing 42866829 updates; total_prefilling_elapsed_ms=1101 ms)
pref_size=999912
pref_millis=1101
prefill_elapsed_ms=1120
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=221942.871701830
REALTIME_END_PERF_FORMAT=221952.871771653

###############################################################################
################################## 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 (256 threads)...
partitioned into 1830 subtrees; running parallel for...
computing stats for the top of the tree (above the partitions)...

tree_stats_computeWalltime=0.117s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 253 496 949 1742 3147 5353 8561 12949 18467 25189 32548 39765 46520 51368 54200 54726 52956 49310 43960 37752 30855 24383 18608 13516 9387 6207 3930 2321 1331 768 427 242 146 86 44 17 7 5 2 1 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 1 6 28 88 186 517 1176 2260 4062 6405 9607 13612 17743 22327 25988 28410 29849 29810 28808 26347 23562 19521 15821 12365 9164 6539 4415 2918 1690 969 572 317 179 106 71 36 12 2 4 1 1
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 254 502 977 1830 3333 5870 9737 15209 22529 31594 42155 53377 64263 73695 80188 83136 82805 79120 72768 64099 54417 43904 34429 25881 18551 12746 8345 5239 3021 1737 999 559 325 192 115 53 19 7 6 2 1
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 254 502 977 1830 3333 5870 9737 15209 22529 31594 42155 53377 64263 73695 80188 83136 82805 79120 72768 64099 54417 43904 34429 25881 18551 12746 8345 5239 3021 1737 999 559 325 192 115 53 19 7 6 2 1
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 1.98438 1.98031 1.95817 1.90174 1.8694 1.81698 1.74685 1.68276 1.62989 1.58267 1.537 1.49411 1.45896 1.42287 1.39107 1.36085 1.33775 1.31597 1.29649 1.27676 1.25999 1.2398 1.22882 1.21125 1.19454 1.18107 1.16774 1.15686 1.13361 1.13439 1.13299 1.13213 1.14848 1.14154 1.15104 1.07826 1.03774 1 1.14286 1 1 1

tree_stats_height=49
tree_stats_numInternals=652749
tree_stats_numLeaves=345495
tree_stats_numNodes=998244
tree_stats_numKeys=998244

tree_stats_avgDegreeInternal=1.52929
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.3461
tree_stats_avgKeyDepth=23.7037


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:4 2:95 4:9679 8:344651 16:285015 32:104 64:172 128:151
    [2^00, 2^01]: 4
    (2^01, 2^02]: 95
    (2^02, 2^03]: 9679
    (2^03, 2^04]: 344651
    (2^04, 2^05]: 285015
    (2^05, 2^06]: 104
    (2^06, 2^07]: 172
    (2^07, 2^08]: 151
sum_limbo_reclamation_event_size_total=9720844
count_limbo_reclamation_event_size_by_thread=9998 9998 9998 9997 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 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998 9998
count_limbo_reclamation_event_size_total=639871
sum_limbo_reclamation_event_count_total=917696
first_thread_announced_epoch_by_thread=30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970 30970
sum_num_inserts_by_thread=443878 437195 435673 433012 435130 435568 432899 429353 437993 437911 436811 436852 435682 444645 441240 440809 435036 434162 434006 441728 431984 435147 429538 430632 434693 428380 435331 434679 433917 440626 440406 433320 435766 435832 439472 436673 429689 431186 429789 428922 428016 436239 439866 432273 442627 441789 434692 433361 429160 435703 426884 433254 428084 427493 426250 433344 440986 433744 441633 433714 434651 444168 443597 435467
sum_num_inserts_total=27852560
sum_num_deletes_by_thread=444634 436508 435448 433422 435851 436018 433120 429325 439009 438027 436331 437897 436925 444067 441052 441736 434450 431916 434409 442071 433113 435721 428314 429217 435847 429304 434597 434534 433214 441061 442220 433747 436283 436323 439825 438117 429699 430075 430295 429668 427906 437112 439016 434117 442904 442095 434147 433206 430416 437118 427759 434448 429292 426123 426483 434169 441857 433818 441763 434380 433972 444016 443544 435928
sum_num_deletes_total=27868979
sum_num_searches_by_thread=8010398 7870790 7843684 7803875 7844847 7832474 7783712 7738668 7885757 7903433 7867886 7861002 7864620 8008607 7943381 7936285 7837906 7806867 7819296 7956186 7786686 7858513 7705528 7738855 7833380 7729858 7841540 7816991 7800955 7942840 7924630 7789537 7846717 7848502 7924219 7870427 7730807 7756709 7726819 7731865 7713802 7841956 7913718 7792725 7977214 7970609 7824698 7805728 7739299 7848726 7693071 7822377 7700109 7686376 7678886 7800166 7934483 7810444 7939818 7810878 7806136 7994023 7983550 7856733
sum_num_searches_total=501570577
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=8898910 8744493 8714805 8670309 8715828 8704060 8649731 8597346 8762759 8779371 8741028 8735751 8737227 8897319 8825673 8818830 8707392 8672945 8687711 8839985 8651783 8729381 8563380 8598704 8703920 8587542 8711468 8686204 8668086 8824527 8807256 8656604 8718766 8720657 8803516 8745217 8590195 8617970 8586903 8590455 8569724 8715307 8792600 8659115 8862745 8854493 8693537 8672295 8598875 8721547 8547714 8690079 8557485 8539992 8531619 8667679 8817326 8678006 8823214 8678972 8674759 8882207 8870691 8728128
average_num_operations_total=8707689
stdev_num_operations_total=11982
sum_num_operations_total=557292116
min_num_operations_total=8531619
max_num_operations_total=8898910
first_time_thread_terminate_by_thread=10000072 10000072 10000072 10000072 10000071 10000071 10000071 10000071 10000074 10000074 10000074 10000074 10000075 10000075 10000075 10000075 10000073 10000073 10000073 10000073 10000071 10000071 10000071 10000071 10000074 10000074 10000074 10000073 10000072 10000072 10000072 10000072 10000073 10000073 10000073 10000071 10000076 10000076 10000076 10000076 10000075 10000075 10000075 10000075 10000074 10000074 10000074 10000074 10000073 10000073 10000073 10000073 10000071 10000071 10000071 10000071 10000073 10000073 10000073 10000073 10000074 10000074 10000074 10000074
min_time_thread_terminate_total=10000071
max_time_thread_terminate_total=10000076
first_time_thread_start_by_thread=3 3 3 3 3 3 3 3 5 5 5 5 5 5 5 5 5 5 5 5 7 7 7 7 8 8 8 8 8 8 8 8 8 8 8 8 6 6 6 6 7 7 7 7 7 7 7 7 7 7 7 7 4 4 4 4 6 6 6 6 4 5 4 4
min_time_thread_start_total=3
max_time_thread_start_total=8
sum_duration_all_ops_total=

threads_final_keysum=998416987252
threads_final_size=998244
final_keysum=998416987252
final_size=998244
validate_result=success
Validation OK.
Structural validation OK.

total_find=501570577
total_rq=0
total_inserts=27852560
total_deletes=27868979
total_updates=55721539
total_queries=501570577
total_ops=557292116
find_throughput=50157057
rq_throughput=0
update_throughput=5572153
query_throughput=50157057
total_throughput=55729211


total find                    : 501570577
total rq                      : 0
total inserts                 : 27852560
total deletes                 : 27868979
total updates                 : 55721539
total queries                 : 501570577
total ops                     : 557292116
find throughput               : 50157057
rq throughput                 : 0
update throughput             : 5572153
query throughput              : 50157057
total throughput              : 55729211

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

garbage=113487185639637
total_execution_walltime=11.361s
REALTIME_MAIN_END_PERF_FORMAT=221953.81315453
[time_cmd_output] time_elapsed_sec=11.46, faults_major=0, faults_minor=92214, mem_maxresident_kb=369728, user_cputime=737.00, sys_cputime=5.41, percent_cpu=6474%
timeout=false
algorithm=sigouin_int_bst_kcas_validate.debra
thread_pinning=-pin 0-63,128-191,64-127,192-255
millis=10000
__trials=2