__step=000532
__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_abtree_tm_auto.debra.rhnorec_post -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=data000532.txt
__path_data=data/data000532.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=7001222.772134592
binary=./brown_abtree_tm_auto.debra.rhnorec_post
parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
DS_TYPENAME=brown_abtree_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=200
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


RH noREC w/postfix htm system ready

Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.012s
prefilling_size=78686 prefilling_elapsed_millis=1.001s
prefilling_size=82473 prefilling_elapsed_millis=1.101s
prefilling_size=85745 prefilling_elapsed_millis=1.201s
prefilling_size=88502 prefilling_elapsed_millis=1.301s
prefilling_size=90401 prefilling_elapsed_millis=1.402s
prefilling_size=92285 prefilling_elapsed_millis=1.502s
prefilling_size=93538 prefilling_elapsed_millis=1.602s
prefilling_size=94734 prefilling_elapsed_millis=1.702s
prefilling_size=95581 prefilling_elapsed_millis=1.802s
prefilling_size=96530 prefilling_elapsed_millis=1.902s
prefilling_size=96908 prefilling_elapsed_millis=2.003s
prefilling_size=97726 prefilling_elapsed_millis=2.103s
prefilling_size=98054 prefilling_elapsed_millis=2.203s
finished prefilling to size 98065 for expected size 100000 keysum=9790798326, performing 804486 updates; total_prefilling_elapsed_ms=2304 ms)
pref_size=98065
pref_millis=2304
prefill_elapsed_ms=2330
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=7001225.272294397
REALTIME_END_PERF_FORMAT=7001235.272452168

###############################################################################
################################## TIME IS UP #################################
###############################################################################

joining threads...
###############################################################################
################################# END RUNNING #################################
###############################################################################

10.1s
PRODUCING OUTPUT
computing tree_stats in PARALLEL...
bounded depth BFS to partition into subtrees for parallel computation (192 threads)...
partitioned into 2641 subtrees; running parallel for...
computing stats for the top of the tree (above the partitions)...

tree_stats_computeWalltime=0.055s

tree_stats_numInternalsAtDepth=1 1 4 41 337 2641 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 19584
tree_stats_numNodesAtDepth=1 1 4 41 337 2641 19584
tree_stats_numKeysAtDepth=0 0 0 0 0 0 99844
tree_stats_avgDegreeAtDepth=1 4 10.25 8.21951 7.8368 7.41537 5.09824

tree_stats_height=7
tree_stats_numInternals=3025
tree_stats_numLeaves=19584
tree_stats_numNodes=22609
tree_stats_numKeys=99844

tree_stats_avgDegreeInternal=7.47405
tree_stats_avgDegreeLeaves=5.09824
tree_stats_avgDegree=5.41612
tree_stats_avgKeyDepth=6


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=60863
first_thread_announced_epoch_by_thread=1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1288 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290 1290
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=36743264
sum_fasthtm_abort_total=78184651
sum_htmpostfix_commit_total=1907471
sum_htmpostfix_abort_total=6112403
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=52189169
sum_stmprefix_commit_total=752
sum_slow_commit_total=25476
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=23058 16555 21506 21538 21614 21497 23798 17198 21707 21600 21532 21579 23397 17050 21383 21871 21483 21759 23633 17472 21322 21170 21521 21975 23009 16742 21650 21535 21552 21537 23346 17141 21567 21792 21791 21565 23464 16905 21400 21570 21484 21845 23156 17571 21108 21375 21521 21750 20269 15436 19548 19757 19521 19359 21253 16352 19831 20010 19325 19739 20977 15989 19088 19015 19080 19563 20732 16204 19829 20145 20110 19772 20520 15290 19517 19824 19328 19498 21280 15954 19847 20034 19336 19844 20980 16029 18952 19439 19193 19675 20580 15685 19765 19942 20269 19936
sum_num_inserts_total=1935215
sum_num_deletes_by_thread=22836 16510 21077 21459 21583 21584 23851 16908 21661 21559 21378 21223 23481 17097 21541 21862 21590 21724 23457 17529 21369 21778 21499 21946 22682 16787 21533 21548 21834 21162 23368 16903 21725 22034 21499 21712 23492 17063 21425 21952 21587 22252 23694 17710 21122 21247 21776 21899 20596 15381 19733 19747 20009 19449 21109 15856 19751 20298 19594 19220 21320 16290 18943 19258 19246 19361 20514 16158 19775 20056 19633 19813 20515 15176 19421 19853 19397 19402 21284 15958 19742 20113 19502 19671 20981 15952 19087 19254 19261 19649 20447 15902 19618 20018 19964 19870
sum_num_deletes_total=1935655
sum_num_searches_by_thread=414833 295162 385568 385643 390396 390569 428430 303944 391362 385701 386296 383492 420583 305043 385299 389377 387795 388857 418812 316893 382928 387140 390968 399285 412094 300536 384081 385460 391315 379552 422081 305324 388801 391526 385181 389729 420430 308361 385387 390803 387038 395082 424570 314770 379751 382062 391673 391977 369324 278147 352506 354583 354815 347387 380775 291930 358471 362171 352325 351672 381435 290651 340518 343197 342517 354939 371954 290978 356130 362468 357110 356512 371229 274535 348300 357308 346914 351360 379267 288211 355225 363171 350307 354613 380297 287946 338748 348467 345072 354352 368064 284825 356220 359272 360010 357905
sum_num_searches_total=34806093
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=460727 328227 428151 428640 433593 433650 476079 338050 434730 428860 429206 426294 467461 339190 428223 433110 430868 432340 465902 351894 425619 430088 433988 443206 457785 334065 427264 428543 434701 422251 468795 339368 432093 435352 428471 433006 467386 342329 428212 434325 430109 439179 471420 350051 421981 424684 434970 435626 410189 308964 391787 394087 394345 386195 423137 324138 398053 402479 391244 390631 423732 322930 378549 381470 380843 393863 413200 323340 395734 402669 396853 396097 412264 305001 387238 396985 385639 390260 421831 320123 394814 403318 389145 394128 422258 319927 376787 387160 383526 393676 409091 316412 395603 399232 400243 397711
average_num_operations_total=402885
stdev_num_operations_total=4160
sum_num_operations_total=38676963
min_num_operations_total=305001
max_num_operations_total=476079
first_time_thread_terminate_by_thread=10000375 10000366 10000191 10000350 10000166 10000318 10000411 10000248 10000191 10000290 10000198 10000255 10000159 10000286 10000270 10000267 10000193 10000193 10000329 10000391 10000286 10000342 10000298 10000242 10000350 10000230 10000380 10000384 10000264 10000367 10000413 10000208 10000213 10000249 10000319 10000247 10000370 10000280 10000367 10000280 10000274 10000394 10000359 10000388 10000300 10000300 10000352 10000256 10000403 10000409 10000343 10000293 10000163 10000401 10000223 10000406 10000281 10000380 10000330 10000400 10000171 10000188 10000336 10000373 10000324 10000187 10000306 10000379 10000395 10000331 10000243 10000257 10000370 10000356 10000162 10000237 10000295 10000397 10000326 10000225 10000307 10000405 10000161 10000314 10000309 10000410 10000302 10000249 10000161 10000408 10000389 10000366 10000339 10000169 10000179 10000417
min_time_thread_terminate_total=10000159
max_time_thread_terminate_total=10000417
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 4 4 4 4 4 4 4 5 4 4 4 5 4 4 4 4 4 4 4 5 4 4 4 4 4 4 4 4 4 4 4 5 4 4 4 5 4 4 4 4 4 4 4 5 4 4 4 4
min_time_thread_start_total=4
max_time_thread_start_total=5
sum_duration_all_ops_total=

threads_final_keysum=9987569828
threads_final_size=99844
final_keysum=9987569828
final_size=99844
validate_result=success
Validation OK.
Structural validation OK.

total_find=34806093
total_rq=0
total_inserts=1935215
total_deletes=1935655
total_updates=3870870
total_queries=34806093
total_ops=38676963
find_throughput=3480609
rq_throughput=0
update_throughput=387087
query_throughput=3480609
total_throughput=3867696


total find                    : 34806093
total rq                      : 0
total inserts                 : 1935215
total deletes                 : 1935655
total updates                 : 3870870
total queries                 : 34806093
total ops                     : 38676963
find throughput               : 3480609
rq throughput                 : 0
update throughput             : 387087
query throughput              : 3480609
total throughput              : 3867696

elapsed milliseconds          : 10000
napping milliseconds overtime : 100

PAPI_L2_TCM=24.8683
PAPI_L3_TCM=5.39851
PAPI_TOT_CYC=61516.8
PAPI_TOT_INS=3143.03
garbage=1722384863401
total_execution_walltime=12.701s
REALTIME_MAIN_END_PERF_FORMAT=7001235.474134312
RH noREC w/postfix htm system shutdown:
    HTM_ATTEMPT_THRESH=40
[time_cmd_output] time_elapsed_sec=12.84, faults_major=0, faults_minor=97517, mem_maxresident_kb=387600, user_cputime=1189.32, sys_cputime=18.13, percent_cpu=9403%
timeout=false
algorithm=brown_abtree_tm_auto.debra.rhnorec_post
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=2