__step=000491 __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.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=data000491.txt __path_data=data/data000491.txt __hostname=jax REALTIME_MAIN_START_PERF_FORMAT=7000718.700133842 binary=./brown_sigouin_int_avl_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_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 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=79093 prefilling_elapsed_millis=1.001s prefilling_size=82173 prefilling_elapsed_millis=1.101s prefilling_size=84880 prefilling_elapsed_millis=1.201s prefilling_size=87319 prefilling_elapsed_millis=1.301s prefilling_size=89290 prefilling_elapsed_millis=1.402s prefilling_size=90880 prefilling_elapsed_millis=1.502s prefilling_size=92503 prefilling_elapsed_millis=1.602s prefilling_size=93635 prefilling_elapsed_millis=1.702s prefilling_size=94593 prefilling_elapsed_millis=1.802s prefilling_size=95456 prefilling_elapsed_millis=1.903s prefilling_size=96141 prefilling_elapsed_millis=2.003s prefilling_size=96789 prefilling_elapsed_millis=2.103s prefilling_size=97348 prefilling_elapsed_millis=2.203s prefilling_size=97749 prefilling_elapsed_millis=2.303s prefilling_size=97917 prefilling_elapsed_millis=2.404s prefilling_size=98174 prefilling_elapsed_millis=2.504s finished prefilling to size 98168 for expected size 100000 keysum=9835660071, performing 845079 updates; total_prefilling_elapsed_ms=2605 ms) pref_size=98168 pref_millis=2605 prefill_elapsed_ms=2636 main thread: starting timer... ############################################################################### ################################ BEGIN RUNNING ################################ ############################################################################### REALTIME_START_PERF_FORMAT=7000721.519999747 REALTIME_END_PERF_FORMAT=7000731.520143872 ############################################################################### ################################## 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.032s tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4090 7926 13279 15666 9742 2480 160 0 tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 5 227 2145 8719 16180 11995 3173 201 tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4095 8153 15424 24385 25922 14475 3333 201 tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4095 8153 15424 24385 25922 14475 3333 201 tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 1.99951 1.99219 1.91966 1.72005 1.42059 1.18259 1.05893 1.0123 1 tree_stats_height=20 tree_stats_numInternals=57438 tree_stats_numLeaves=42645 tree_stats_numNodes=100083 tree_stats_numKeys=100083 tree_stats_avgDegreeInternal=1.74245 tree_stats_avgDegreeLeaves=1 tree_stats_avgDegree=1.4261 tree_stats_avgKeyDepth=15.012 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=48576 first_thread_announced_epoch_by_thread=1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 1032 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=29123667 sum_fasthtm_abort_total=62186713 sum_htmpostfix_commit_total=1501322 sum_htmpostfix_abort_total=6534154 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=49838068 sum_stmprefix_commit_total=596 sum_slow_commit_total=31664 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=16922 16944 17325 17276 14223 17600 16454 16659 16881 17064 14235 17534 16329 16932 16883 16597 14091 17491 17029 16905 16527 16895 14372 17679 16977 16984 16760 17004 14253 17844 16534 16391 17206 17023 14111 17730 16643 17175 16684 16805 14200 17463 16885 16864 16547 16570 14233 17795 15782 15941 16120 16043 13078 13280 15897 15853 16123 15919 13642 16850 16112 15775 15824 15911 13438 16935 15368 15509 15823 15916 12644 16113 15944 15684 16047 16064 13812 13225 15800 15789 15982 16212 13606 16857 15963 15978 15774 15749 13252 16846 15152 15476 15838 16273 11912 16316 sum_num_inserts_total=1532975 sum_num_deletes_by_thread=16947 16980 17104 17091 14487 17558 16783 16549 16964 17181 13822 17430 16608 17071 16784 16703 14067 17721 16777 16895 16558 16907 14276 18018 17037 16906 16946 16551 14429 17473 16771 16394 17318 16937 14163 17688 16407 17121 16784 17109 14243 17596 16849 16815 16499 16625 14270 17878 15848 15922 15889 15769 12976 13058 15688 15851 15908 16161 13662 16782 16025 16007 15676 15848 13513 16698 15570 15354 15940 15979 12798 16193 15993 16128 16213 16029 13637 13171 15628 15611 16119 16096 13547 16840 16060 16061 15791 15711 13562 16882 15197 15472 15949 15894 12227 16263 sum_num_deletes_total=1533286 sum_num_searches_by_thread=305118 304505 308458 306942 257413 316341 301856 297975 306453 305230 253234 314649 296374 307168 301808 296603 252752 315853 302963 303742 302593 304837 256601 320420 307125 307092 304982 299746 255595 319449 298904 296102 312507 306645 253084 317339 299422 310194 301268 307023 258288 317488 304153 302369 298726 298272 256677 320404 283533 287178 284726 286868 234928 237037 283393 287645 289948 287349 247241 300863 289888 284962 282663 286218 242803 301598 276932 276716 283293 286840 227935 291771 284626 288285 290502 290971 246057 236228 284452 282179 291171 290830 247234 303724 289852 288534 285353 283212 238463 304167 272099 279184 285498 284820 216814 291663 sum_num_searches_total=27590988 sum_num_rq_by_thread= sum_num_rq_total= sum_num_operations_by_thread=338987 338429 342887 341309 286123 351499 335093 331183 340298 339475 281291 349613 329311 341171 335475 329903 280910 351065 336769 337542 335678 338639 285249 356117 341139 340982 338688 333301 284277 354766 332209 328887 347031 340605 281358 352757 332472 344490 334736 340937 286731 352547 337887 336048 331772 331467 285180 356077 315163 319041 316735 318680 260982 263375 314978 319349 321979 319429 274545 334495 322025 316744 314163 317977 269754 335231 307870 307579 315056 318735 253377 324077 316563 320097 322762 323064 273506 262624 315880 313579 323272 323138 274387 337421 321875 320573 316918 314672 265277 337895 302448 310132 317285 316987 240953 324242 average_num_operations_total=319346 stdev_num_operations_total=2657 sum_num_operations_total=30657249 min_num_operations_total=240953 max_num_operations_total=356117 first_time_thread_terminate_by_thread=10000426 10000358 10000303 10000145 10000393 10000148 10000375 10000146 10000373 10000230 10000402 10000342 10000804 10000185 10000375 10000794 10000247 10000343 10000411 10000362 10000410 10000813 10000332 10000359 10000283 10000811 10000157 10000145 10000348 10000148 10000230 10000378 10000162 10000152 10000806 10000397 10000146 10000199 10000317 10000331 10000216 10000294 10000381 10000207 10000224 10000389 10000250 10000243 10000176 10000209 10000819 10000312 10000818 10000382 10000405 10000208 10000407 10000380 10000306 10000429 10000314 10000390 10000391 10000217 10000149 10000415 10000212 10000829 10000810 10000821 10000828 10000824 10000147 10000826 10000831 10000827 10000820 10000295 10000817 10000372 10000415 10000799 10000802 10000301 10000815 10000793 10000333 10000822 10000370 10000195 10000825 10000828 10000369 10000389 10000350 10000830 min_time_thread_terminate_total=10000145 max_time_thread_terminate_total=10000831 first_time_thread_start_by_thread=6 6 5 5 6 5 5 5 5 5 6 6 5 6 5 5 5 6 6 6 5 5 6 5 6 6 5 5 6 5 5 5 5 5 6 6 5 6 5 5 5 6 6 6 5 5 6 5 5 6 5 5 5 5 6 6 6 6 6 5 6 5 5 6 5 5 6 5 5 5 5 6 5 6 5 5 5 5 6 6 6 6 6 5 6 5 5 6 5 5 6 5 5 5 5 6 min_time_thread_start_total=5 max_time_thread_start_total=6 sum_duration_all_ops_total= threads_final_keysum=10002536252 threads_final_size=100083 final_keysum=10002536252 final_size=100083 validate_result=success Validation OK. Structural validation OK. total_find=27590988 total_rq=0 total_inserts=1532975 total_deletes=1533286 total_updates=3066261 total_queries=27590988 total_ops=30657249 find_throughput=2759098 rq_throughput=0 update_throughput=306626 query_throughput=2759098 total_throughput=3065724 total find : 27590988 total rq : 0 total inserts : 1532975 total deletes : 1533286 total updates : 3066261 total queries : 27590988 total ops : 30657249 find throughput : 2759098 rq throughput : 0 update throughput : 306626 query throughput : 2759098 total throughput : 3065724 elapsed milliseconds : 10000 napping milliseconds overtime : 100 PAPI_L2_TCM=28.1656 PAPI_L3_TCM=6.59663 PAPI_TOT_CYC=77923.2 PAPI_TOT_INS=3700.33 garbage=1377869506973 total_execution_walltime=13.006s REALTIME_MAIN_END_PERF_FORMAT=7000731.707344569 RH noREC w/postfix htm system shutdown: HTM_ATTEMPT_THRESH=40 [time_cmd_output] time_elapsed_sec=13.15, faults_major=0, faults_minor=110425, mem_maxresident_kb=439376, user_cputime=1217.52, sys_cputime=18.64, percent_cpu=9399% timeout=false algorithm=brown_sigouin_int_avl_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=1