__step=000476
__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 96 -nprefill 96 -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=data000476.txt
__path_data=data/data000476.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=7000533.828661940
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=96
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=96
WORK_THREADS=96
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,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


noREC system ready

Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.016s
prefilling_size=98101 prefilling_elapsed_millis=1.001s
finished prefilling to size 98102 for expected size 100000 keysum=9783812566, performing 791390 updates; total_prefilling_elapsed_ms=1102 ms)
pref_size=98102
pref_millis=1102
prefill_elapsed_ms=1129
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=7000535.128307472
REALTIME_END_PERF_FORMAT=7000545.128442030

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

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8105 14184 16330 8897 1744 50 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 82 1751 9733 17755 11199 2192 58
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8187 15935 26063 26652 12943 2242 58
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8187 15935 26063 26652 12943 2242 58
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 1.99878 1.95639 1.74547 1.39604 1.15181 1.03848 1.00357 1

tree_stats_height=20
tree_stats_numInternals=57501
tree_stats_numLeaves=42770
tree_stats_numNodes=100271
tree_stats_numKeys=100271

tree_stats_avgDegreeInternal=1.74381
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.42654
tree_stats_avgKeyDepth=14.9445


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=126432
first_thread_announced_epoch_by_thread=2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652 2652
sum_commit_tx_reader_total=108800012
sum_commit_tx_reader_by_thread=0 1143220 1117136 1109077 1108405 1116109 1107727 1163492 1165562 1131574 1144993 1146233 1156465 1151765 1140198 1142392 1114573 1113206 1131495 1149691 1159837 1158866 1141309 1127697 1173142 1156768 1127713 1138054 1143083 1172713 1125049 1123229 1098196 1094468 1079232 1091942 1109884 1096292 1108376 1137841 1091102 1163329 1119164 1161420 1144336 1128370 1153791 1187463 1132338 1092457 1142823 1106166 1092594 1138886 1156075 1117887 1123323 1125108 1159680 1150521 1097149 1118156 1147781 1139691 1108182 1168928 1155912 1145130 1104527 1113163 1135178 1150802 1141442 1148338 1128495 1150323 1118199 1142020 1142787 1148704 1140590 1148709 1119581 1145635 1147330 1153727 1115473 1095429 1148659 1156197 1112681 1132613 1131276 1148217 1119919 1137418 1137814
sum_commit_tx_writer_total=5723623
sum_commit_tx_writer_by_thread=0 60398 58240 58683 58226 58973 57960 60979 61588 60009 60293 60593 61065 60457 59667 60007 58550 58252 60013 60526 61200 60735 60286 59499 61441 60862 59247 59179 60493 61631 59124 59169 58005 57349 56199 57045 58784 57386 58457 59396 57244 61171 59198 61670 60514 59293 60707 62318 59416 57587 59709 58102 57659 59177 60672 58828 58827 59243 61267 60256 57574 58391 60729 59745 58743 61034 60719 59880 58005 58956 60080 60553 59704 60468 59654 60521 58729 60302 60336 60414 59705 60353 59061 60356 60895 60807 58905 57887 59603 60864 58451 59451 59128 61018 59563 59851 60364
sum_abort_tx_total=23091
sum_abort_tx_by_thread=0 257 256 258 246 244 238 242 243 213 254 245 242 251 217 254 236 251 258 252 250 228 240 244 232 248 238 254 242 261 232 234 231 250 219 221 231 245 226 240 239 243 235 238 237 224 243 281 242 244 246 268 233 246 227 207 222 232 242 248 236 255 247 218 228 255 237 231 250 227 252 243 239 251 255 265 215 250 250 249 246 262 232 220 223 247 256 224 227 254 245 233 267 229 190 225 238
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 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=15.6:28 25.2:889 34.8:41723 44.4:50512 54:2362 63.6:428 73.2:48 82.8:9
    [        6.00,        15.60]: 28
    (       15.60,        25.20]: 889
    (       25.20,        34.80]: 41723
    (       34.80,        44.40]: 50512
    (       44.40,        54.00]: 2362
    (       54.00,        63.60]: 428
    (       63.60,        73.20]: 48
    (       73.20,        82.80]: 9

linear_histogram_of_none_tx_wrset_size_full_data=3.5:28405 6:6167 8.5:18371 11:12393 13.5:14277 16:8960 18.5:5749 21:309 23.5:1304 26:58
    [        1.00,         3.50]: 28405
    (        3.50,         6.00]: 6167
    (        6.00,         8.50]: 18371
    (        8.50,        11.00]: 12393
    (       11.00,        13.50]: 14277
    (       13.50,        16.00]: 8960
    (       16.00,        18.50]: 5749
    (       18.50,        21.00]: 309
    (       21.00,        23.50]: 1304
    (       23.50,        26.00]: 58
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=60357 58391 59649 60579 57767 61543 58539 60533 61054 60523 58364 60493 61076 61189 58096 61549 57358 61206 59307 59927 60552 59732 58794 61961 57711 60757 59893 60612 59290 60821 60602 58883 60672 59672 59798 61520 59341 59229 59912 60847 59460 62516 57755 60568 58018 57683 59020 61410 58944 58706 60256 56652 57690 60037 60967 59817 57714 59923 60497 60646 56938 59974 58747 57760 58533 59929 60585 60388 57218 59833 58776 59523 58518 59183 60471 58318 58530 57920 59870 60468 60384 58365 60385 58705 60016 60856 60098 58443 59955 60818 59435 59685 58307 60480 60210 60836
sum_num_inserts_total=5724838
sum_num_deletes_by_thread=60022 58872 59949 60628 58176 60626 58383 60392 61502 60692 58934 60849 61129 61467 59097 61341 57632 60772 59329 59503 60027 60225 59233 61388 57468 60628 59437 61318 59751 61236 60144 59299 60362 59586 59763 61499 59401 58975 59905 60292 59215 62778 58106 61260 57371 57610 58945 61589 58981 58979 60407 56505 57700 60450 60443 60274 58005 60045 60685 60481 57432 59854 58698 57343 59206 59837 60575 60313 56918 59766 59014 59023 58212 58523 60630 58318 58584 58407 59939 60854 60484 58813 60148 59057 59426 59823 60056 58013 60080 60733 59254 59710 58956 60850 59938 60425
sum_num_deletes_total=5726273
sum_num_searches_by_thread=1077799 1059452 1071985 1085619 1046589 1102302 1050003 1084361 1101944 1091007 1053834 1087168 1095325 1098381 1059354 1100200 1035054 1098969 1060846 1072634 1081016 1079908 1066146 1111234 1035074 1093113 1080106 1097671 1072713 1107905 1082830 1063968 1083816 1077975 1071947 1111325 1068454 1066147 1082582 1089078 1068285 1124487 1048407 1095802 1037927 1039430 1060397 1104151 1060717 1056693 1088143 1022274 1036427 1082636 1093124 1084919 1040482 1080327 1090173 1089717 1034617 1075430 1059483 1038575 1054380 1081380 1087958 1088361 1034210 1077638 1057292 1069117 1049901 1050962 1087124 1051124 1054344 1049360 1082723 1095739 1085123 1058198 1083085 1064636 1078621 1090098 1082168 1050377 1088227 1095080 1071715 1068754 1055860 1095417 1077121 1087974
sum_num_searches_total=103072524
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=1198178 1176715 1191583 1206826 1162532 1224471 1166925 1205286 1224500 1212222 1171132 1208510 1217530 1221037 1176547 1223090 1150044 1220947 1179482 1192064 1201595 1199865 1184173 1234583 1150253 1214498 1199436 1219601 1191754 1229962 1203576 1182150 1204850 1197233 1191508 1234344 1187196 1184351 1202399 1210217 1186960 1249781 1164268 1217630 1153316 1154723 1178362 1227150 1178642 1174378 1208806 1135431 1151817 1203123 1214534 1205010 1156201 1200295 1211355 1210844 1148987 1195258 1176928 1153678 1172119 1201146 1209118 1209062 1148346 1197237 1175082 1187663 1166631 1168668 1208225 1167760 1171458 1165687 1202532 1217061 1205991 1175376 1203618 1182398 1198063 1210777 1202322 1166833 1208262 1216631 1190404 1188149 1173123 1216747 1197269 1209235
average_num_operations_total=1192954
stdev_num_operations_total=2408
sum_num_operations_total=114523635
min_num_operations_total=1135431
max_num_operations_total=1249781
first_time_thread_terminate_by_thread=10000137 10000137 10000135 10000137 10000137 10000135 10000135 10000135 10000136 10000137 10000136 10000135 10000135 10000135 10000137 10000135 10000137 10000135 10000138 10000136 10000138 10000136 10000137 10000136 10000137 10000137 10000135 10000137 10000137 10000137 10000136 10000136 10000136 10000138 10000135 10000135 10000135 10000135 10000137 10000135 10000135 10000135 10000138 10000136 10000136 10000136 10000136 10000136 10000138 10000138 10000137 10000134 10000136 10000134 10000135 10000134 10000138 10000135 10000138 10000134 10000135 10000136 10000137 10000138 10000135 10000136 10000138 10000134 10000137 10000134 10000134 10000140 10000138 10000134 10000137 10000136 10000134 10000137 10000135 10000134 10000138 10000137 10000136 10000134 10000136 10000137 10000134 10000134 10000134 10000134 10000138 10000134 10000138 10000138 10000134 10000134
min_time_thread_terminate_total=10000134
max_time_thread_terminate_total=10000140
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 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 3 3 3 2 3 3 3 3 3 3 3 3 3 3 2 2 3 3 2 3 3 3 3 3 3 3 3 2 3 3 3 3 3 3 3 3 3 3 2 2 3 3 2 3 3 3 3 3 3 3
min_time_thread_start_total=2
max_time_thread_start_total=3
sum_duration_all_ops_total=

threads_final_keysum=10019424145
threads_final_size=100271
final_keysum=10019424145
final_size=100271
validate_result=success
Validation OK.
Structural validation OK.

total_find=103072524
total_rq=0
total_inserts=5724838
total_deletes=5726273
total_updates=11451111
total_queries=103072524
total_ops=114523635
find_throughput=10307252
rq_throughput=0
update_throughput=1145111
query_throughput=10307252
total_throughput=11452363


total find                    : 103072524
total rq                      : 0
total inserts                 : 5724838
total deletes                 : 5726273
total updates                 : 11451111
total queries                 : 103072524
total ops                     : 114523635
find throughput               : 10307252
rq throughput                 : 0
update throughput             : 1145111
query throughput              : 10307252
total throughput              : 11452363

elapsed milliseconds          : 10000
napping milliseconds overtime : 0

PAPI_L2_TCM=15.3683
PAPI_L3_TCM=2.12299
PAPI_TOT_CYC=21004.3
PAPI_TOT_INS=7192.61
garbage=5095254958174
total_execution_walltime=11.756s
REALTIME_MAIN_END_PERF_FORMAT=7000545.586835437
noREC system shutdown:
[time_cmd_output] time_elapsed_sec=11.90, faults_major=0, faults_minor=116286, mem_maxresident_kb=462412, user_cputime=1071.64, sys_cputime=25.16, percent_cpu=9216%
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