__step=000354
__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_abtree_kcas_validate.debra -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=data000354.txt
__path_data=data/data000354.txt
__hostname=jax
sizeof(kcasdesc_t)=1920
sizeof(rdcssdesc_t)=192
addrof(kcasDescriptors[0])=0x558b4d83f480
addrof(kcasDescriptors[1])=0x558b4d83fc00
addrof(rdcssDescriptors[0])=0x558b4d92f480
addrof(rdcssDescriptors[1])=0x558b4d92f540
sizeof(validationSet)=1608
REALTIME_MAIN_START_PERF_FORMAT=6999088.461417762
binary=./brown_sigouin_abtree_kcas_validate.debra
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=brown_sigouin_abtree_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=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=40
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=1000256 prefilling_elapsed_millis=1.001s
finished prefilling to size 1000231 for expected size 1000000 keysum=1000586666086, performing 65116315 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=1000231
pref_millis=1102
prefill_elapsed_ms=1132
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=6999089.766268230
REALTIME_END_PERF_FORMAT=6999099.766406123

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

tree_stats_computeWalltime=0.067s

tree_stats_numInternalsAtDepth=1 1 9 66 491 3632 28368 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 195669
tree_stats_numNodesAtDepth=1 1 9 66 491 3632 28368 195669
tree_stats_numKeysAtDepth=0 0 0 0 0 0 0 1000679
tree_stats_avgDegreeAtDepth=1 9 7.33333 7.43939 7.39715 7.81057 6.89753 5.11414

tree_stats_height=8
tree_stats_numInternals=32568
tree_stats_numLeaves=195669
tree_stats_numNodes=228237
tree_stats_numKeys=1000679

tree_stats_avgDegreeInternal=7.00801
tree_stats_avgDegreeLeaves=5.11414
tree_stats_avgDegree=5.38439
tree_stats_avgKeyDepth=7


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:63987 2:79331 4:12149 8:121
    [2^00, 2^01]: 63987
    (2^01, 2^02]: 79331
    (2^02, 2^03]: 12149
    (2^03, 2^04]: 121
sum_limbo_reclamation_event_size_total=280882
count_limbo_reclamation_event_size_by_thread=3240 3256 3276 3248 3184 3290 3152 3166 3110 3274 3360 3190 3304 3268 3186 3274 3274 3334 3280 3268 3176 3200 3206 3244 3152 3076 3266 3240 3264 3050 3274 3146 3166 3370 3206 3208 3410 3232 3260 3284 3204 3354 3192 3244 3314 3322 3344 3250
count_limbo_reclamation_event_size_total=155588
sum_limbo_reclamation_event_count_total=3387840
first_thread_announced_epoch_by_thread=76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564 76564
sum_commit_tx_reader_total=
sum_commit_tx_reader_by_thread=
sum_commit_tx_writer_total=
sum_commit_tx_writer_by_thread=
sum_abort_tx_total=
sum_abort_tx_by_thread=
max_ht_capacity_by_thread=

linear_histogram_of_none_tx_rdset_size_full_data=

linear_histogram_of_none_tx_wrset_size_full_data=
sum_fasthtm_commit_total=
sum_fasthtm_abort_total=
sum_htmpostfix_commit_total=
sum_htmpostfix_abort_total=
sum_htmprefix_commit_total=
sum_htmprefix_abort_total=
sum_htmprefix_abort_explicit_total=
sum_htmprefix_abort_conflict_total=
sum_htmprefix_abort_capacity_total=
sum_htmprefix_abort_nesting_total=
sum_htmprefix_abort_illegal_total=
sum_htmprefix_abort_zero_total=
sum_stmprefix_abort_total=
sum_stmprefix_commit_total=
sum_slow_commit_total=
sum_abtree_insert_repeat_total=386
sum_abtree_erase_repeat_total=75
sum_abtree_search_repeat_total=15
sum_abtree_search_complete_total=78494303
sum_abtree_fix_weight_viol_attempt_total=74786
sum_abtree_fix_degree_viol_attempt_total=581205
sum_abtree_rebalancing_kcas_attempt_total=655912
sum_abtree_update_kcas_attempt_total=38911899
sum_abtree_internal_complex_search_while_iters_total=78494366
sum_abtree_internal_basic_search_while_iters_total=700490208
sum_kcas_desc_new_total=
sum_num_inserts_by_thread=807214 811951 813859 811989 807933 800083 803371 810678 814397 815698 806216 803525 810392 812261 818720 816411 812500 810469 805728 811074 816206 816214 806042 805214 808294 810571 813871 809970 812688 802837 805838 810973 814145 817765 805518 803901 805358 814754 819982 817528 812325 810847 805474 809687 816525 818855 810264 806524
sum_num_inserts_total=38912639
sum_num_deletes_by_thread=807303 813061 817350 812548 809944 800669 804186 810323 812718 818272 805881 804180 810122 814100 817667 815786 813644 811941 805741 811809 814572 817598 807031 806453 807495 811449 812723 810204 815182 802321 806905 808308 815641 815503 805665 806266 805967 811800 817887 817775 811878 811805 803828 810571 816091 818575 811838 806429
sum_num_deletes_total=38925005
sum_num_searches_by_thread=14533985 14616996 14684272 14619913 14569037 14421268 14477715 14574701 14632515 14688567 14499187 14450141 14589082 14641635 14741047 14713576 14636406 14609935 14513135 14616169 14680873 14709259 14514861 14510583 14535256 14597863 14639006 14608369 14662625 14432766 14509173 14575745 14664017 14683865 14496417 14483161 14498218 14633948 14717085 14729017 14586107 14587560 14486285 14578800 14696057 14730174 14596375 14514102
sum_num_searches_total=700486849
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=16148502 16242008 16315481 16244450 16186914 16022020 16085272 16195702 16259630 16322537 16111284 16057846 16209596 16267996 16377434 16345773 16262550 16232345 16124604 16239052 16311651 16343071 16127934 16122250 16151045 16219883 16265600 16228543 16290495 16037924 16121916 16195026 16293803 16317133 16107600 16093328 16109543 16260502 16354954 16364320 16210310 16210212 16095587 16199058 16328673 16367604 16218477 16127055
average_num_operations_total=16215093
stdev_num_operations_total=13943
sum_num_operations_total=778324493
min_num_operations_total=16022020
max_num_operations_total=16377434
first_time_thread_terminate_by_thread=10000137 10000136 10000137 10000136 10000137 10000137 10000136 10000137 10000137 10000136 10000136 10000136 10000136 10000136 10000136 10000137 10000136 10000137 10000136 10000137 10000136 10000136 10000136 10000136 10000137 10000136 10000137 10000136 10000137 10000137 10000136 10000137 10000137 10000136 10000136 10000136 10000136 10000136 10000136 10000137 10000136 10000137 10000136 10000137 10000136 10000136 10000136 10000136
min_time_thread_terminate_total=10000136
max_time_thread_terminate_total=10000137
first_time_thread_start_by_thread=4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4 4
min_time_thread_start_total=4
max_time_thread_start_total=4
sum_duration_all_ops_total=

threads_final_keysum=1001270430252
threads_final_size=1000679
final_keysum=1001270430252
final_size=1000679
validate_result=success
Validation OK.
Structural validation OK.

total_find=700486849
total_rq=0
total_inserts=38912639
total_deletes=38925005
total_updates=77837644
total_queries=700486849
total_ops=778324493
find_throughput=70048684
rq_throughput=0
update_throughput=7783764
query_throughput=70048684
total_throughput=77832449


total find                    : 700486849
total rq                      : 0
total inserts                 : 38912639
total deletes                 : 38925005
total updates                 : 77837644
total queries                 : 700486849
total ops                     : 778324493
find throughput               : 70048684
rq throughput                 : 0
update throughput             : 7783764
query throughput              : 70048684
total throughput              : 77832449

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=11.2667
PAPI_L3_TCM=1.24297
PAPI_TOT_CYC=1629.95
PAPI_TOT_INS=892.1
garbage=350165582244778
total_execution_walltime=11.472s
REALTIME_MAIN_END_PERF_FORMAT=6999099.941795388
[time_cmd_output] time_elapsed_sec=11.61, faults_major=0, faults_minor=87721, mem_maxresident_kb=351724, user_cputime=565.58, sys_cputime=1.37, percent_cpu=4879%
timeout=false
algorithm=brown_sigouin_abtree_kcas_validate.debra
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=2