__step=000294
__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.hytm1 -nwork 144 -nprefill 144 -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=data000294.txt
__path_data=data/data000294.txt
__hostname=jax
REALTIME_MAIN_START_PERF_FORMAT=6998217.636317348
binary=./brown_sigouin_int_avl_tm_auto.debra.hytm1
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=2000000
PREFILL_THREADS=144
DESIRED_PREFILL_SIZE=-1
TOTAL_THREADS=144
WORK_THREADS=144
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,48,49,50,51,52,53,54,55,56,57,58,59,60,61,62,63,64,65,66,67,68,69,70,71,144,145,146,147,148,149,150,151,152,153,154,155,156,157,158,159,160,161,162,163,164,165,166,167


HyTM1 system ready

Info: prefilling using hybrid approach; mixed then insert-only if needed.
prefilling initialization took 0.055s
prefilling_size=634562 prefilling_elapsed_millis=1s
prefilling_size=694200 prefilling_elapsed_millis=1.1s
prefilling_size=745520 prefilling_elapsed_millis=1.2s
prefilling_size=784916 prefilling_elapsed_millis=1.3s
prefilling_size=814794 prefilling_elapsed_millis=1.401s
prefilling_size=840466 prefilling_elapsed_millis=1.501s
prefilling_size=862833 prefilling_elapsed_millis=1.601s
prefilling_size=882318 prefilling_elapsed_millis=1.701s
prefilling_size=899445 prefilling_elapsed_millis=1.801s
prefilling_size=913369 prefilling_elapsed_millis=1.901s
prefilling_size=925688 prefilling_elapsed_millis=2.001s
prefilling_size=936141 prefilling_elapsed_millis=2.101s
prefilling_size=945570 prefilling_elapsed_millis=2.201s
prefilling_size=953790 prefilling_elapsed_millis=2.301s
prefilling_size=961138 prefilling_elapsed_millis=2.402s
prefilling_size=966604 prefilling_elapsed_millis=2.502s
prefilling_size=971438 prefilling_elapsed_millis=2.602s
prefilling_size=975908 prefilling_elapsed_millis=2.702s
prefilling_size=979758 prefilling_elapsed_millis=2.802s
prefilling_size=983215 prefilling_elapsed_millis=2.902s
finished prefilling to size 983230 for expected size 1000000 keysum=983836938571, performing 8087096 updates; total_prefilling_elapsed_ms=3004 ms)
pref_size=983230
pref_millis=3004
prefill_elapsed_ms=3043
main thread: starting timer...

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

REALTIME_START_PERF_FORMAT=6998220.976171206
REALTIME_END_PERF_FORMAT=6998230.976249067

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

tree_stats_computeWalltime=0.03s

tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32763 64905 117219 155535 119408 44829 6400 223 1 0
tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 5 561 10897 64265 146116 139338 56405 8096 270 1
tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65466 128116 219800 265524 184167 62805 8319 271 1
tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65466 128116 219800 265524 184167 62805 8319 271 1
tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 1.99802 1.96555 1.80069 1.5004 1.24389 1.09761 1.03055 1.00577 1 1

tree_stats_height=25
tree_stats_numInternals=574050
tree_stats_numLeaves=425954
tree_stats_numNodes=1000004
tree_stats_numKeys=1000004

tree_stats_avgDegreeInternal=1.74202
tree_stats_avgDegreeLeaves=1
tree_stats_avgDegree=1.42595
tree_stats_avgKeyDepth=18.3357


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=202896
first_thread_announced_epoch_by_thread=2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900 2900
sum_num_inserts_by_thread=93104 96719 97415 97328 95909 95971 95748 96408 98487 96654 95714 90387 96362 97302 96907 96157 97727 96902 96807 97124 94692 92813 97308 95333 96255 96681 97599 95725 96593 94508 96599 97210 97985 98093 91279 94228 96202 96568 96333 96461 95739 95341 94945 96177 97582 95842 96709 95088 95920 97806 98849 97202 95660 96497 97553 98108 98540 98726 97239 97432 97206 98154 95633 98007 94315 96767 95630 96139 95992 98356 92448 96334 96379 96784 99031 97916 96027 95638 96493 97589 98279 98425 98114 97403 97568 97197 96736 98020 94478 96144 92387 95810 97123 96762 96565 97245 94110 94694 96435 94127 96497 95211 95046 94701 96068 94607 95337 95033 95861 95059 95603 97056 94312 93090 93044 94784 94576 93052 95545 93213 94029 94495 95664 95109 94742 91779 94068 94096 96974 94993 95381 94372 94006 95805 95935 93978 95053 93896 93978 94992 96037 74749 94282 93111
sum_num_inserts_total=13788231
sum_num_deletes_by_thread=92887 96757 97116 97389 95950 96041 95499 96568 98391 97049 96368 90563 96689 96706 96910 96176 97610 97043 96468 96791 95162 92405 96479 95506 96114 96755 97271 95774 97316 95198 96562 96815 97933 97624 91608 94395 96102 97073 96270 97067 95432 94888 95432 95918 96850 95713 95488 94987 96135 97599 98423 97463 95553 96311 97305 97681 98147 98971 97317 97393 97571 97674 95796 97851 94194 97048 95457 95544 96331 98806 92658 96416 96918 97740 98912 97596 95502 96569 96865 97455 97511 98691 97773 97618 97087 97414 97340 98293 94067 96506 92769 96105 96916 96860 96563 97304 93819 94907 96093 94866 96311 95035 94036 94703 96456 94690 95316 95094 95660 94440 95507 96358 94814 92967 93552 94798 94700 93273 95314 93535 94516 94608 95755 94780 94717 92028 93894 94224 96326 95069 95574 94644 93560 95684 96012 94711 95265 94419 93814 95020 95801 74964 93975 93480
sum_num_deletes_total=13788210
sum_num_searches_by_thread=1669944 1744448 1749333 1751443 1734018 1726619 1724945 1738577 1770082 1743747 1728506 1626238 1734819 1742474 1740305 1730825 1761006 1737830 1738083 1743824 1705590 1664097 1744153 1717983 1732609 1738222 1757184 1724677 1744212 1710743 1731253 1752780 1763685 1761651 1644717 1702461 1733549 1747238 1739208 1738794 1724892 1717362 1710509 1731974 1753040 1719743 1735483 1707813 1728060 1760149 1772811 1753564 1718129 1735214 1751892 1762762 1772854 1774705 1751960 1754245 1757846 1765869 1725623 1760809 1696827 1739769 1717558 1723972 1736832 1766487 1656397 1743449 1744807 1753078 1774081 1755080 1723121 1728267 1746417 1754315 1761978 1777719 1768749 1762639 1744864 1746140 1751234 1764912 1701626 1729187 1662625 1729971 1746180 1742652 1737082 1747858 1692464 1699771 1732919 1707985 1727265 1715846 1698531 1704594 1737214 1706136 1706409 1707670 1719517 1705431 1720930 1737549 1702364 1682730 1680144 1710476 1710964 1678039 1716114 1684280 1701018 1700300 1716747 1714134 1711342 1655077 1693652 1692933 1736586 1710589 1715705 1710408 1693772 1720115 1727079 1697593 1713454 1700655 1691500 1712991 1737184 1352878 1692596 1676907
sum_num_searches_total=248235610
sum_num_rq_by_thread=
sum_num_rq_total=
sum_num_operations_by_thread=1855935 1937924 1943864 1946160 1925877 1918631 1916192 1931553 1966960 1937450 1920588 1807188 1927870 1936482 1934122 1923158 1956343 1931775 1931358 1937739 1895444 1849315 1937940 1908822 1924978 1931658 1952054 1916176 1938121 1900449 1924414 1946805 1959603 1957368 1827604 1891084 1925853 1940879 1931811 1932322 1916063 1907591 1900886 1924069 1947472 1911298 1927680 1897888 1920115 1955554 1970083 1948229 1909342 1928022 1946750 1958551 1969541 1972402 1946516 1949070 1952623 1961697 1917052 1956667 1885336 1933584 1908645 1915655 1929155 1963649 1841503 1936199 1938104 1947602 1972024 1950592 1914650 1920474 1939775 1949359 1957768 1974835 1964636 1957660 1939519 1940751 1945310 1961225 1890171 1921837 1847781 1921886 1940219 1936274 1930210 1942407 1880393 1889372 1925447 1896978 1920073 1906092 1887613 1893998 1929738 1895433 1897062 1897797 1911038 1894930 1912040 1930963 1891490 1868787 1866740 1900058 1900240 1864364 1906973 1871028 1889563 1889403 1908166 1904023 1900801 1838884 1881614 1881253 1929886 1900651 1906660 1899424 1881338 1911604 1919026 1886282 1903772 1888970 1879292 1903003 1929022 1502591 1880853 1863498
average_num_operations_total=1915361
stdev_num_operations_total=3923
sum_num_operations_total=275812051
min_num_operations_total=1502591
max_num_operations_total=1974835
first_time_thread_terminate_by_thread=10000143 10000138 10000140 10000137 10000153 10000139 10000137 10000142 10000140 10000138 10000142 10000143 10000142 10000140 10000141 10000143 10000143 10000142 10000141 10000137 10000142 10000137 10000141 10000140 10000143 10000224 10000143 10000141 10000137 10000139 10000140 10000140 10000140 10000138 10000142 10000143 10000142 10000140 10000141 10000143 10000137 10000143 10000137 10000143 10000142 10000137 10000144 10000140 10000141 10000139 10000139 10000142 10000139 10000138 10000138 10000138 10000138 10000141 10000138 10000137 10000142 10000139 10000138 10000138 10000142 10000140 10000139 10000139 10000139 10000138 10000139 10000139 10000141 10000139 10000138 10000142 10000139 10000138 10000139 10000140 10000138 10000141 10000138 10000137 10000138 10000138 10000138 10000138 10000142 10000140 10000139 10000139 10000139 10000139 10000139 10000139 10000143 10000143 10000141 10000143 10000139 10000141 10000141 10000140 10000141 10000141 10000139 10000140 10000139 10000140 10000140 10000141 10000139 10000142 10000140 10000140 10000140 10000139 10000139 10000142 10000143 10000143 10000141 10000143 10000139 10000141 10000141 10000140 10000141 10000141 10000139 10000140 10000139 10000140 10000140 10000141 10000139 10000142 10000140 10000140 10000140 10000139 10000139 10000142
min_time_thread_terminate_total=10000137
max_time_thread_terminate_total=10000224
first_time_thread_start_by_thread=5 6 6 6 6 6 5 5 6 6 6 5 6 5 5 5 5 6 6 6 6 6 5 6 9 6 6 6 6 6 5 5 6 6 6 5 6 5 5 5 5 6 6 6 6 6 5 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 5 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 5 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6
min_time_thread_start_total=5
max_time_thread_start_total=9
sum_duration_all_ops_total=

threads_final_keysum=999736370858
threads_final_size=1000004
final_keysum=999736370858
final_size=1000004
validate_result=success
Validation OK.
Structural validation OK.

total_find=248235610
total_rq=0
total_inserts=13788231
total_deletes=13788210
total_updates=27576441
total_queries=248235610
total_ops=275812051
find_throughput=24823561
rq_throughput=0
update_throughput=2757644
query_throughput=24823561
total_throughput=27581205


total find                    : 248235610
total rq                      : 0
total inserts                 : 13788231
total deletes                 : 13788210
total updates                 : 27576441
total queries                 : 248235610
total ops                     : 275812051
find throughput               : 24823561
rq throughput                 : 0
update throughput             : 2757644
query throughput              : 24823561
total throughput              : 27581205

elapsed milliseconds          : 10000
napping milliseconds overtime : 100

PAPI_L2_TCM=14.4131
PAPI_L3_TCM=2.55168
PAPI_TOT_CYC=14319.6
PAPI_TOT_INS=17147
garbage=123138971059073
total_execution_walltime=13.518s
REALTIME_MAIN_END_PERF_FORMAT=6998231.155439266
HyTM1 system shutdown:
    HTM_ATTEMPT_THRESH=40
[fast htm]
total fast htm commit         : 283703935
[slow htm]
[fallback]
total fallback commit         : 195213
seconds global lock is held   : 10.1797
[time_cmd_output] time_elapsed_sec=13.68, faults_major=0, faults_minor=304147, mem_maxresident_kb=797196, user_cputime=1890.58, sys_cputime=13.82, percent_cpu=13913%
timeout=false
algorithm=brown_sigouin_int_avl_tm_auto.debra.hytm1
thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191
millis=10000
__trials=2