__step=000211 __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" ./sigouin_int_avl_kcas_validate_htm.debra -nwork 96 -nprefill 96 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 5.0 5.0 -k 20000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 __file_data=data000211.txt __path_data=data/data000211.txt __hostname=jax sizeof(kcasdesc_t)=2304 sizeof(rdcssdesc_t)=192 addrof(kcasDescriptors[0])=0x55eb0efa3400 addrof(kcasDescriptors[1])=0x55eb0efa3d00 addrof(rdcssDescriptors[0])=0x55eb0f0c3400 addrof(rdcssDescriptors[1])=0x55eb0f0c34c0 sizeof(validationSet)=1608 REALTIME_MAIN_START_PERF_FORMAT=6996981.424690605 binary=./sigouin_int_avl_kcas_validate_htm.debra parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 DS_TYPENAME=sigouin_int_avl_kcas_validate_htm 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=20000000 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=56 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 Info: prefilling using hybrid approach; mixed then insert-only if needed. prefilling initialization took 0.011s prefilling_size=8552414 prefilling_elapsed_millis=1.001s prefilling_size=8781783 prefilling_elapsed_millis=1.101s prefilling_size=8974340 prefilling_elapsed_millis=1.201s prefilling_size=9134588 prefilling_elapsed_millis=1.301s prefilling_size=9268166 prefilling_elapsed_millis=1.402s prefilling_size=9383831 prefilling_elapsed_millis=1.502s prefilling_size=9476738 prefilling_elapsed_millis=1.602s prefilling_size=9556897 prefilling_elapsed_millis=1.702s prefilling_size=9625921 prefilling_elapsed_millis=1.802s prefilling_size=9680926 prefilling_elapsed_millis=1.903s prefilling_size=9728636 prefilling_elapsed_millis=2.003s prefilling_size=9769776 prefilling_elapsed_millis=2.103s prefilling_size=9806685 prefilling_elapsed_millis=2.203s finished prefilling to size 9806707 for expected size 10000000 keysum=98072965121277, performing 79744389 updates; total_prefilling_elapsed_ms=2305 ms) pref_size=9806707 pref_millis=2305 prefill_elapsed_ms=2329 main thread: starting timer... ############################################################################### ################################ BEGIN RUNNING ################################ ############################################################################### REALTIME_START_PERF_FORMAT=6996983.932482093 REALTIME_END_PERF_FORMAT=6996993.932631732 ############################################################################### ################################## 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.053s tree_stats_numInternalsAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262122 521785 986872 1501132 1416117 655342 121554 6386 16 0 tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 20 2258 49679 391123 1234865 1591377 819751 154995 7978 19 tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262142 524043 1036551 1892255 2650982 2246719 941305 161381 7994 19 tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8192 16384 32768 65536 131072 262142 524043 1036551 1892255 2650982 2246719 941305 161381 7994 19 tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 2 1.99998 1.99916 1.9823 1.87346 1.60766 1.31332 1.12728 1.04231 1.00996 1.00038 1 tree_stats_height=28 tree_stats_numInternals=5733469 tree_stats_numLeaves=4252065 tree_stats_numNodes=9985534 tree_stats_numKeys=9985534 tree_stats_avgDegreeInternal=1.74162 tree_stats_avgDegreeLeaves=1 tree_stats_avgDegree=1.42582 tree_stats_avgKeyDepth=21.6482 log_histogram_of_none_limbo_reclamation_event_size_full_data=1:0 2:0 4:30 8:27267 16:533940 32:23019 (2^02, 2^03]: 30 (2^03, 2^04]: 27267 (2^04, 2^05]: 533940 (2^05, 2^06]: 23019 sum_limbo_reclamation_event_size_total=13454048 count_limbo_reclamation_event_size_by_thread=6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 6086 count_limbo_reclamation_event_size_total=584256 sum_limbo_reclamation_event_count_total=584448 first_thread_announced_epoch_by_thread=14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 14052 sum_num_inserts_by_thread=280657 283143 282991 284377 282588 279513 281757 281247 285194 285072 281708 280616 279850 283153 285739 286031 284273 281003 278672 280513 281961 284423 281250 279900 280691 282053 283148 283205 282070 279665 281642 282230 284066 285017 281690 279209 281032 283023 284887 284755 284722 280419 279830 280748 282106 284480 280879 279761 280306 282822 283252 283900 283207 280635 280090 283136 284962 285356 283193 282595 281211 282511 285338 285400 283227 279723 278206 280182 283709 283274 281184 280002 279857 283120 283790 283269 281930 280054 279292 281799 284656 285038 283534 279798 282252 282938 284769 283927 280792 280196 280127 280361 283119 285038 283496 280581 sum_num_inserts_total=27098113 sum_num_deletes_by_thread=280518 283559 284167 285001 283541 278607 279999 282196 284581 285796 281661 279516 280969 283526 284495 285225 283065 281146 278966 281129 282552 284115 281728 279782 280282 281019 284255 283362 283022 279941 280940 282805 284264 283563 282625 280399 280817 282448 285088 284704 283030 280128 279786 280443 282194 284204 280850 278978 279975 282482 283593 284172 283515 280817 281845 282244 285190 286849 282604 281858 281052 281631 284562 284708 282206 280811 278888 280203 283075 283655 280562 279615 280418 282232 283274 283667 282024 279381 280540 280482 284618 284249 283087 280953 282056 283146 283687 284797 280217 280017 279840 281128 283299 284178 282274 281315 sum_num_deletes_total=27091978 sum_num_searches_by_thread=5053333 5084391 5106452 5118802 5098404 5036732 5049239 5067977 5132380 5127596 5057043 5031222 5056902 5100367 5135094 5130192 5096456 5065479 5032737 5056787 5088834 5115701 5070466 5031170 5058782 5064747 5107096 5095131 5077825 5028144 5068526 5085125 5118837 5121954 5076213 5034514 5050888 5086442 5136101 5112556 5093096 5048254 5028594 5041218 5079267 5120350 5049190 5028759 5048445 5090011 5110758 5123511 5082641 5045119 5054989 5097110 5128324 5149926 5091009 5071928 5058866 5087998 5138054 5129232 5091429 5044399 5019887 5052273 5095053 5091033 5053201 5037578 5047845 5080655 5101847 5108126 5081106 5033172 5039051 5060607 5118665 5132039 5103253 5059569 5082016 5095407 5120012 5115559 5045646 5038928 5029922 5055093 5106982 5128472 5090770 5053811 sum_num_searches_total=487676692 sum_num_rq_by_thread= sum_num_rq_total= sum_num_operations_by_thread=5614508 5651093 5673610 5688180 5664533 5594852 5610995 5631420 5702155 5698464 5620412 5591354 5617721 5667046 5705328 5701448 5663794 5627628 5590375 5618429 5653347 5684239 5633444 5590852 5619755 5627819 5674499 5661698 5642917 5587750 5631108 5650160 5687167 5690534 5640528 5594122 5612737 5651913 5706076 5682015 5660848 5608801 5588210 5602409 5643567 5689034 5610919 5587498 5608726 5655315 5677603 5691583 5649363 5606571 5616924 5662490 5698476 5722131 5656806 5636381 5621129 5652140 5707954 5699340 5656862 5604933 5576981 5612658 5661837 5657962 5614947 5597195 5608120 5646007 5668911 5675062 5645060 5592607 5598883 5622888 5687939 5701326 5669874 5620320 5646324 5661491 5688468 5684283 5606655 5599141 5589889 5616582 5673400 5697688 5656540 5615707 average_num_operations_total=5644445 stdev_num_operations_total=3806 sum_num_operations_total=541866783 min_num_operations_total=5576981 max_num_operations_total=5722131 first_time_thread_terminate_by_thread=10000151 10000149 10000148 10000149 10000151 10000148 10000149 10000150 10000148 10000148 10000150 10000148 10000148 10000150 10000150 10000151 10000149 10000150 10000150 10000148 10000151 10000151 10000149 10000148 10000151 10000149 10000148 10000149 10000151 10000148 10000149 10000150 10000150 10000150 10000150 10000148 10000151 10000149 10000149 10000149 10000149 10000150 10000150 10000148 10000151 10000151 10000149 10000148 10000152 10000149 10000149 10000150 10000149 10000150 10000150 10000149 10000149 10000151 10000151 10000149 10000149 10000151 10000150 10000149 10000151 10000149 10000151 10000150 10000150 10000152 10000149 10000149 10000152 10000149 10000149 10000150 10000149 10000150 10000150 10000149 10000149 10000151 10000151 10000151 10000149 10000151 10000150 10000149 10000151 10000149 10000151 10000150 10000149 10000152 10000149 10000149 min_time_thread_terminate_total=10000148 max_time_thread_terminate_total=10000152 first_time_thread_start_by_thread=6 7 6 6 6 6 7 6 6 15 6 7 6 6 6 6 7 6 15 7 6 6 6 15 6 7 6 6 6 6 7 6 6 15 6 7 6 6 6 6 7 6 15 7 6 6 6 15 6 6 6 6 6 6 6 7 6 6 6 7 6 6 6 6 6 6 7 6 6 6 6 7 6 6 6 6 6 6 6 7 6 6 6 7 6 6 6 6 6 6 7 6 6 6 6 7 min_time_thread_start_total=6 max_time_thread_start_total=15 sum_duration_all_ops_total= threads_final_keysum=99848631722874 threads_final_size=9985534 final_keysum=99848631722874 final_size=9985534 validate_result=success Validation OK. Structural validation OK. total_find=487676692 total_rq=0 total_inserts=27098113 total_deletes=27091978 total_updates=54190091 total_queries=487676692 total_ops=541866783 find_throughput=48767669 rq_throughput=0 update_throughput=5419009 query_throughput=48767669 total_throughput=54186678 total find : 487676692 total rq : 0 total inserts : 27098113 total deletes : 27091978 total updates : 54190091 total queries : 487676692 total ops : 541866783 find throughput : 48767669 rq throughput : 0 update throughput : 5419009 query throughput : 48767669 total throughput : 54186678 elapsed milliseconds : 10000 napping milliseconds overtime : 0 PAPI_L2_TCM=27.8059 PAPI_L3_TCM=10.1172 PAPI_TOT_CYC=4933.87 PAPI_TOT_INS=1303.6 garbage=2422794921189491 total_execution_walltime=12.678s REALTIME_MAIN_END_PERF_FORMAT=6996994.103520222 [time_cmd_output] time_elapsed_sec=12.87, faults_major=0, faults_minor=238050, mem_maxresident_kb=950060, user_cputime=1207.67, sys_cputime=4.07, percent_cpu=9412% timeout=false algorithm=sigouin_int_avl_kcas_validate_htm.debra thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 millis=10000 __trials=1