__step=000474
__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_int_avl_tm_auto.debra.norec -nwork 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 5.0 5.0 -k 200000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
__file_data=data000474.txt
__path_data=data/data000474.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=7000509.922927798
binary=./brown_sigouin_int_avl_tm_auto.debra.norec
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=brown_sigouin_int_avl_tm_auto
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=200000
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=48
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


noREC system ready

Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.007s
prefilling_size=99983 prefilling_elapsed_millis=1.001s
finished prefilling to size 99978 for expected size 100000 keysum=10000739722, performing 1891602 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=99978
pref_millis=1102
prefill_elapsed_ms=1126
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=7000511.238226854
REALTIME_END_PERF_FORMAT=7000521.238374839

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

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4092 8103 13908 15507 9233 2292 166 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 3 75 2007 9721 16308 11366 2923 198
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4095 8178 15915 25228 25541 13658 3089 198
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4095 8178 15915 25228 25541 13658 3089 198
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 1.99951 1.9978 1.95525 1.71128 1.39773 1.17325 1.05835 1.01036 1

tree_stats_height=20
tree_stats_numInternals=57396
tree_stats_numLeaves=42601
tree_stats_numNodes=99997
tree_stats_numKeys=99997

tree_stats_avgDegreeInternal=1.74223
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.42602
tree_stats_avgKeyDepth=14.979


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:0
    [2^00, 2^01]: 0
sum_limbo_reclamation_event_size_total=
count_limbo_reclamation_event_size_by_thread=
count_limbo_reclamation_event_size_total=
sum_limbo_reclamation_event_count_total=328560
first_thread_announced_epoch_by_thread=13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872 13872
sum_commit_tx_reader_total=143388614
sum_commit_tx_reader_by_thread=0 2976208 3010225 2978277 2991339 2982899 3015580 2953482 3005001 3021663 3013531 3001482 3010205 2957735 2987965 2998176 3011769 2981582 2974104 2991017 2958929 2966025 2993547 3045022 2962349 3011210 3015211 3004675 2980676 2981007 2948242 2971155 3008798 2989243 3002707 2999112 2972346 3010913 2999783 2990042 3012861 2967263 2954345 2968853 2973977 2952655 2986446 2912942 2986040
sum_commit_tx_writer_total=7542133
sum_commit_tx_writer_by_thread=0 156614 158711 156826 157653 157164 158052 155238 157835 158272 157991 157674 158189 156229 157027 157558 158836 156404 156512 157799 156136 155918 157403 160398 156540 158150 158610 158142 156937 156075 155296 156874 158888 157018 157550 158503 155960 158305 157797 157566 158839 155882 155301 155523 156108 154657 157335 153057 156781
sum_abort_tx_total=11867
sum_abort_tx_by_thread=0 245 245 248 260 240 228 248 233 278 250 223 245 238 244 235 250 270 250 249 274 255 246 254 234 220 237 247 279 256 238 233 267 237 246 252 228 259 249 266 247 215 250 235 268 249 252 253 242
max_ht_capacity_by_thread=0 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048 2048

linear_histogram_of_none_tx_rdset_size_full_data=16.4:28 23.8:210 31.2:3738 38.6:39486 46:3272 53.4:1025 60.8:191 68.2:35 75.6:13 83:1
    [        9.00,        16.40]: 28
    (       16.40,        23.80]: 210
    (       23.80,        31.20]: 3738
    (       31.20,        38.60]: 39486
    (       38.60,        46.00]: 3272
    (       46.00,        53.40]: 1025
    (       53.40,        60.80]: 191
    (       60.80,        68.20]: 35
    (       68.20,        75.60]: 13
    (       75.60,        83.00]: 1

linear_histogram_of_none_tx_wrset_size_full_data=3.6:14525 6.2:3464 8.8:8780 11.4:8227 14:4987 16.6:5522 19.2:1843 21.8:428 24.4:219 27:4
    [        1.00,         3.60]: 14525
    (        3.60,         6.20]: 3464
    (        6.20,         8.80]: 8780
    (        8.80,        11.40]: 8227
    (       11.40,        14.00]: 4987
    (       14.00,        16.60]: 5522
    (       16.60,        19.20]: 1843
    (       19.20,        21.80]: 428
    (       21.80,        24.40]: 219
    (       24.40,        27.00]: 4
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=
sum_abtree_erase_repeat_total=
sum_abtree_search_repeat_total=
sum_abtree_search_complete_total=
sum_abtree_fix_weight_viol_attempt_total=
sum_abtree_fix_degree_viol_attempt_total=
sum_abtree_rebalancing_kcas_attempt_total=
sum_abtree_update_kcas_attempt_total=
sum_abtree_internal_complex_search_while_iters_total=
sum_abtree_internal_basic_search_while_iters_total=
sum_kcas_desc_new_total=
sum_num_inserts_by_thread=157853 155926 159008 158122 157889 155592 157789 155771 157679 157649 157854 156536 158602 157713 157181 159198 156738 156459 156899 156038 156183 157115 156027 159939 158260 158739 158367 156382 156595 154917 156748 158615 157330 158349 158004 156266 158542 157951 157267 158814 156163 155751 156212 156328 155027 157629 153336 156909
sum_num_inserts_total=7544261
sum_num_deletes_by_thread=158499 156085 158648 158843 158275 155058 158243 157531 158762 157589 155722 156845 158320 156622 158237 157834 156167 156553 157852 156103 156184 158690 156341 160447 157967 158816 158145 157048 156073 155022 155980 158906 157010 157368 157903 156149 158840 157440 157495 159212 155682 155681 155447 156086 154901 157371 153038 157469
sum_num_deletes_total=7544499
sum_num_searches_by_thread=2855170 2801953 2862279 2851429 2846672 2798070 2843124 2819520 2852495 2833754 2821527 2826682 2856710 2830657 2840316 2853573 2825081 2817604 2834065 2802924 2809576 2835145 2806521 2885034 2853133 2856266 2846305 2824183 2824414 2793599 2815301 2850165 2831921 2844540 2841708 2815891 2851836 2842189 2832846 2853674 2811300 2798214 2812717 2817671 2797384 2828781 2759625 2828443
sum_num_searches_total=135841987
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=3171522 3113964 3179935 3168394 3162836 3108720 3159156 3132822 3168936 3148992 3135103 3140063 3173632 3144992 3155734 3170605 3137986 3130616 3148816 3115065 3121943 3150950 3118889 3205420 3169360 3173821 3162817 3137613 3137082 3103538 3128029 3167686 3146261 3160257 3157615 3128306 3169218 3157580 3147608 3171700 3123145 3109646 3124376 3130085 3107312 3143781 3065999 3142821
average_num_operations_total=3144390
stdev_num_operations_total=3705
sum_num_operations_total=150930747
min_num_operations_total=3065999
max_num_operations_total=3205420
first_time_thread_terminate_by_thread=10000147 10000147 10000148 10000147 10000148 10000149 10000149 10000149 10000149 10000149 10000147 10000148 10000148 10000149 10000149 10000149 10000149 10000148 10000147 10000150 10000148 10000147 10000149 10000147 10000147 10000148 10000148 10000149 10000149 10000149 10000149 10000149 10000149 10000148 10000147 10000147 10000149 10000149 10000149 10000149 10000149 10000148 10000147 10000149 10000147 10000147 10000149 10000147
min_time_thread_terminate_total=10000147
max_time_thread_terminate_total=10000150
first_time_thread_start_by_thread=3 4 4 4 4 3 3 3 3 3 3 3 3 4 4 4 3 3 3 3 4 3 3 4 3 4 4 4 4 3 3 3 3 3 3 3 3 4 4 4 3 3 3 3 4 3 3 4
min_time_thread_start_total=3
max_time_thread_start_total=4
sum_duration_all_ops_total=

threads_final_keysum=9995412777
threads_final_size=99997
final_keysum=9995412777
final_size=99997
validate_result=success
Validation OK.
Structural validation OK.

total_find=135841987
total_rq=0
total_inserts=7544261
total_deletes=7544499
total_updates=15088760
total_queries=135841987
total_ops=150930747
find_throughput=13584198
rq_throughput=0
update_throughput=1508876
query_throughput=13584198
total_throughput=15093074


total find                    : 135841987
total rq                      : 0
total inserts                 : 7544261
total deletes                 : 7544499
total updates                 : 15088760
total queries                 : 135841987
total ops                     : 150930747
find throughput               : 13584198
rq throughput                 : 0
update throughput             : 1508876
query throughput              : 13584198
total throughput              : 15093074

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=11.4855
PAPI_L3_TCM=0.00513283
PAPI_TOT_CYC=7166.43
PAPI_TOT_INS=5084
garbage=6794222545650
total_execution_walltime=11.68s
REALTIME_MAIN_END_PERF_FORMAT=7000521.604144323
noREC system shutdown:
[time_cmd_output] time_elapsed_sec=11.81, faults_major=0, faults_minor=126659, mem_maxresident_kb=508520, user_cputime=527.82, sys_cputime=37.14, percent_cpu=4782%
timeout=false
algorithm=brown_sigouin_int_avl_tm_auto.debra.norec
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=2