__step=000452
__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_int_bst_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=data000452.txt
__path_data=data/data000452.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=7000246.805421493
binary=./brown_int_bst_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_int_bst_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=32
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=94145 prefilling_elapsed_millis=1.001s
prefilling_size=95691 prefilling_elapsed_millis=1.101s
prefilling_size=96831 prefilling_elapsed_millis=1.201s
prefilling_size=97563 prefilling_elapsed_millis=1.301s
prefilling_size=98593 prefilling_elapsed_millis=1.401s
finished prefilling to size 98613 for expected size 100000 keysum=9876984756, performing 799643 updates; total_prefilling_elapsed_ms=1503 ms)
pref_size=98613
pref_millis=1503
prefill_elapsed_ms=1525
4NodeIxPvL9tx_safety0EE_object_size=32
4NodeIxPvL9tx_safety0EE_allocated_count=0
4NodeIxPvL9tx_safety0EE_allocated_size=0MB
4NodeIxPvL9tx_safety0EE_get_from_pool=0
4NodeIxPvL9tx_safety0EE_deallocated=0
4NodeIxPvL9tx_safety0EE_limbo_count=0
4NodeIxPvL9tx_safety0EE_limbo_details=0 0 0 

global_epoch_counter=10

main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=7000248.604708264
REALTIME_END_PERF_FORMAT=7000258.604788809

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

tree_stats_computeWalltime=0.032s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 125 236 436 758 1250 1921 2820 3797 4872 5909 6553 6755 6424 5658 4876 3990 3052 2253 1517 954 558 322 186 99 35 12 4 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 3 12 23 63 150 312 539 992 1429 2060 2877 3385 3743 3780 3416 3022 2536 2018 1563 1084 694 423 229 149 86 27 10 4
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 248 459 821 1400 2233 3359 4789 6301 7969 9430 10140 10167 9438 8292 7012 5588 4271 3080 2038 1252 745 415 248 121 39 14 4
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 248 459 821 1400 2233 3359 4789 6301 7969 9430 10140 10167 9438 8292 7012 5588 4271 3080 2038 1252 745 415 248 121 39 14 4
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 1.96094 1.89919 1.83878 1.78197 1.70214 1.64398 1.58619 1.52286 1.49151 1.44184 1.38038 1.33649 1.29645 1.27908 1.2576 1.2279 1.21815 1.19363 1.16916 1.14622 1.14936 1.12483 1.1494 1.08871 1.03306 1.05128 1 1

tree_stats_height=35
tree_stats_numInternals=65499
tree_stats_numLeaves=34629
tree_stats_numNodes=100128
tree_stats_numKeys=100128

tree_stats_avgDegreeInternal=1.5287
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.34585
tree_stats_avgKeyDepth=18.8229

4NodeIxPvL9tx_safety0EE_object_size=32
4NodeIxPvL9tx_safety0EE_allocated_count=0
4NodeIxPvL9tx_safety0EE_allocated_size=0MB
4NodeIxPvL9tx_safety0EE_get_from_pool=0
4NodeIxPvL9tx_safety0EE_deallocated=0
4NodeIxPvL9tx_safety0EE_limbo_count=0
4NodeIxPvL9tx_safety0EE_limbo_details=0 0 0 

global_epoch_counter=852


log_histogram_of_none_limbo_reclamation_event_size_full_data=1:0 2:3 4:360 8:35028 16:45241 32:8
    (2^01, 2^02]: 3
    (2^02, 2^03]: 360
    (2^03, 2^04]: 35028
    (2^04, 2^05]: 45241
    (2^05, 2^06]: 8
sum_limbo_reclamation_event_size_total=1303674
count_limbo_reclamation_event_size_by_thread=840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840 840
count_limbo_reclamation_event_size_total=80640
sum_limbo_reclamation_event_count_total=80832
first_thread_announced_epoch_by_thread=1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704 1704
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=49754170
sum_fasthtm_abort_total=105693511
sum_htmpostfix_commit_total=2577832
sum_htmpostfix_abort_total=2936629
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=51963721
sum_stmprefix_commit_total=851
sum_slow_commit_total=19642
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=26610 27109 26885 27707 27528 28230 26959 27319 27285 28204 27865 28360 26480 26853 27139 27923 27456 29127 26998 26984 27439 27276 27438 28453 27206 26918 26882 27810 27518 28231 27097 27116 27342 28456 27903 28293 27120 26744 27196 27774 27209 28317 27308 26843 27239 27332 27741 28818 26544 26699 26381 27002 26480 26534 27261 26778 27309 27385 27002 28255 26988 26988 26575 26657 26535 28078 26603 26357 26950 26653 27034 28583 26643 26630 26712 26984 26626 26887 27021 27519 27257 27913 26924 28189 26898 26668 26544 26576 26652 28043 26594 26497 27466 26722 26641 28725
sum_num_inserts_total=2617002
sum_num_deletes_by_thread=27382 26894 27092 27736 27379 28281 26623 27251 27354 28389 27588 28358 26862 27010 27125 27884 27193 28669 27440 26995 27375 26947 27473 28537 27082 27003 27051 27971 27700 27776 27083 26945 27457 28002 27945 28759 26850 26919 26796 27753 27185 28796 27341 26724 27123 27119 27665 28568 26589 26482 26197 27378 26434 26511 27349 27089 26911 27794 26684 28675 26918 26986 26540 26961 26625 28402 26749 26407 27099 26413 27104 28738 26637 26543 26725 27249 26728 26795 27274 26745 27306 27788 27036 28169 27047 26478 26728 26642 26621 28196 27157 26478 27305 26668 27034 28358
sum_num_deletes_total=2618192
sum_num_searches_by_thread=484704 484149 487506 496556 493750 510967 480285 488309 494443 510972 498517 509574 476629 483369 486786 505958 488408 513454 491539 486327 491839 488542 495527 510390 488187 485650 486207 500461 499382 503989 487794 488107 495316 511217 503982 513177 487565 486558 483786 501099 492834 514381 493681 483711 489804 487004 499466 515310 479526 477537 474376 490089 480684 477557 488846 480955 486153 497394 479630 512213 487796 487173 481747 481194 479401 509447 479961 475433 489368 478827 483555 516272 477589 476405 480137 487865 480603 485671 488096 486901 490746 505043 485932 509150 486734 479255 476452 480544 480690 505018 483511 473652 493032 480241 482778 508954
sum_num_searches_total=47117301
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=538696 538152 541483 551999 548657 567478 533867 542879 549082 567565 553970 566292 529971 537232 541050 561765 543057 571250 545977 540306 546653 542765 550438 567380 542475 539571 540140 556242 554600 559996 541974 542168 550115 567675 559830 570229 541535 540221 537778 556626 547228 571494 548330 537278 544166 541455 554872 572696 532659 530718 526954 544469 533598 530602 543456 534822 540373 552573 533316 569143 541702 541147 534862 534812 532561 565927 533313 528197 543417 531893 537693 573593 530869 529578 533574 542098 533957 539353 542391 541165 545309 560744 539892 565508 540679 532401 529724 533762 533963 561257 537262 526627 547803 533631 536453 566037
average_num_operations_total=545338
stdev_num_operations_total=1293
sum_num_operations_total=52352495
min_num_operations_total=526627
max_num_operations_total=573593
first_time_thread_terminate_by_thread=10000305 10000324 10000308 10000086 10000314 10000335 10000181 10000279 10000094 10000328 10000291 10000141 10000259 10000340 10000144 10000344 10000316 10000092 10000079 10000192 10000238 10000288 10000295 10000080 10000167 10000156 10000312 10000206 10000231 10000318 10000268 10000096 10000345 10000254 10000088 10000246 10000188 10000326 10000348 10000134 10000092 10000342 10000079 10000080 10000150 10000163 10000263 10000132 10000301 10000215 10000095 10000223 10000299 10000218 10000167 10000241 10000280 10000309 10000266 10000329 10000296 10000161 10000215 10000270 10000273 10000340 10000341 10000332 10000084 10000147 10000192 10000293 10000217 10000197 10000184 10000290 10000161 10000270 10000237 10000186 10000226 10000243 10000319 10000304 10000183 10000198 10000245 10000346 10000225 10000140 10000257 10000348 10000267 10000200 10000084 10000337
min_time_thread_terminate_total=10000079
max_time_thread_terminate_total=10000348
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 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3
min_time_thread_start_total=3
max_time_thread_start_total=3
sum_duration_all_ops_total=

threads_final_keysum=10010076001
threads_final_size=100128
final_keysum=10010076001
final_size=100128
validate_result=success
Validation OK.
Structural validation OK.

total_find=47117301
total_rq=0
total_inserts=2617002
total_deletes=2618192
total_updates=5235194
total_queries=47117301
total_ops=52352495
find_throughput=4711730
rq_throughput=0
update_throughput=523519
query_throughput=4711730
total_throughput=5235249


total find                    : 47117301
total rq                      : 0
total inserts                 : 2617002
total deletes                 : 2618192
total updates                 : 5235194
total queries                 : 47117301
total ops                     : 52352495
find throughput               : 4711730
rq throughput                 : 0
update throughput             : 523519
query throughput              : 4711730
total throughput              : 5235249

elapsed milliseconds          : 10000
napping milliseconds overtime : 100

PAPI_L2_TCM=20.1666
PAPI_L3_TCM=4.34418
PAPI_TOT_CYC=46431
PAPI_TOT_INS=3105.33
garbage=2354684145330
total_execution_walltime=11.975s
REALTIME_MAIN_END_PERF_FORMAT=7000258.795667969
RH noREC w/postfix htm system shutdown:
    HTM_ATTEMPT_THRESH=40
[time_cmd_output] time_elapsed_sec=12.13, faults_major=0, faults_minor=94897, mem_maxresident_kb=377632, user_cputime=1115.55, sys_cputime=18.32, percent_cpu=9345%
timeout=false
algorithm=brown_int_bst_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