__step=001002 __cmd_run=LD_PRELOAD=../../setbench/lib/libjemalloc.so timeout 60 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.debra -nwork 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 50.0 50.0 -k 200000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 __file_data=data001002.txt __path_data=data/data001002.txt __hostname=jax sizeof(kcasdesc_t)=2304 sizeof(rdcssdesc_t)=192 addrof(kcasDescriptors[0])=0x55c555846400 addrof(kcasDescriptors[1])=0x55c555846d00 addrof(rdcssDescriptors[0])=0x55c555966400 addrof(rdcssDescriptors[1])=0x55c5559664c0 sizeof(validationSet)=1608 REALTIME_MAIN_START_PERF_FORMAT=6990998.860215112 binary=./sigouin_int_avl_kcas_validate.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 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=50 DEL_FRAC=50 RQ=0 RQSIZE=0 MAXKEY=200000 PREFILL_THREADS=48 DESIRED_PREFILL_SIZE=-1 TOTAL_THREADS=48 WORK_THREADS=48 RQ_THREADS=0 distribution=0 INS_DEL_FRAC=50.0 50.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 Info: prefilling using hybrid approach; mixed then insert-only if needed. prefilling initialization took 0.006s prefilling_size=99918 prefilling_elapsed_millis=1.001s finished prefilling to size 99898 for expected size 100000 keysum=9976444404, performing 35597188 updates; total_prefilling_elapsed_ms=1102 ms) pref_size=99898 pref_millis=1102 prefill_elapsed_ms=1122 main thread: starting timer... ############################################################################### ################################ BEGIN RUNNING ################################ ############################################################################### REALTIME_START_PERF_FORMAT=6991000.134537692 REALTIME_END_PERF_FORMAT=6991010.134696255 ############################################################################### ################################## 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 4096 8164 14933 17639 7861 783 0 tree_stats_numLeavesAtDepth=0 0 0 0 0 0 0 0 0 0 0 0 0 27 1242 9945 20412 10003 957 tree_stats_numNodesAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8191 16175 27584 28273 10786 957 tree_stats_numKeysAtDepth=1 2 4 8 16 32 64 128 256 512 1024 2048 4096 8191 16175 27584 28273 10786 957 tree_stats_avgDegreeAtDepth=2 2 2 2 2 2 2 2 2 2 2 2 1.99976 1.97802 1.78213 1.38551 1.10346 1.01613 1 tree_stats_height=19 tree_stats_numInternals=57571 tree_stats_numLeaves=42586 tree_stats_numNodes=100157 tree_stats_numKeys=100157 tree_stats_avgDegreeInternal=1.73971 tree_stats_avgDegreeLeaves=1 tree_stats_avgDegree=1.42519 tree_stats_avgKeyDepth=14.8743 log_histogram_of_none_limbo_reclamation_event_size_full_data=1:20 2:2 4:4 8:3 16:16 32:374 64:470692 128:8666 256:47 512:0 1024:47 [2^00, 2^01]: 20 (2^01, 2^02]: 2 (2^02, 2^03]: 4 (2^03, 2^04]: 3 (2^04, 2^05]: 16 (2^05, 2^06]: 374 (2^06, 2^07]: 470692 (2^07, 2^08]: 8666 (2^08, 2^09]: 47 (2^09, 2^10]: 0 (2^10, 2^11]: 47 sum_limbo_reclamation_event_size_total=51550773 count_limbo_reclamation_event_size_by_thread=9997 9997 9997 9998 9997 9998 9998 9997 9998 9997 9998 9998 9997 9997 9997 9997 9997 9997 9997 9998 9997 9997 9998 9997 9998 9997 9997 9997 9997 9998 9997 9998 9997 9997 9998 9998 9997 9997 9997 9998 9998 9997 9997 9997 9997 9997 9997 9997 count_limbo_reclamation_event_size_total=479871 sum_limbo_reclamation_event_count_total=763795 first_thread_announced_epoch_by_thread=35286 35286 35286 35286 35286 35284 35286 35286 35286 35286 35286 35286 35286 35284 35286 35286 35286 35286 35286 35286 35284 35286 35284 35284 35284 35286 35284 35284 35286 35286 35286 35286 35286 35286 35284 35284 35284 35284 35286 35286 35286 35284 35284 35286 35286 35286 35286 35284 sum_num_inserts_by_thread=3322910 3434548 3452745 3453286 3444236 3319702 3428445 3443339 3468728 3481312 3457019 3424912 3432954 3437583 3375072 3475607 3335150 3440983 3419359 3433100 3464817 3379651 3449099 3425245 3420556 3437631 3359558 3464769 3456095 3425589 3434918 3453612 3383932 3385771 3351875 3435812 3436405 3451640 3469487 3369376 3364476 3340864 3319423 3343657 3462818 3386750 3459234 3427624 sum_num_inserts_total=164041674 sum_num_deletes_by_thread=3318693 3433577 3454164 3453424 3441868 3317096 3427972 3443545 3466951 3484702 3457474 3428196 3433092 3440385 3375158 3476992 3337280 3441049 3419492 3434001 3467815 3381200 3454247 3418830 3420760 3438663 3360547 3462074 3451010 3427799 3436608 3448382 3382385 3385289 3353563 3432397 3438740 3450019 3471071 3372455 3366023 3342726 3319804 3340024 3460957 3385684 3457001 3431582 sum_num_deletes_total=164042766 sum_num_searches_by_thread= sum_num_searches_total= sum_num_rq_by_thread= sum_num_rq_total= sum_num_operations_by_thread=6641603 6868125 6906909 6906710 6886104 6636798 6856417 6886884 6935679 6966014 6914493 6853108 6866046 6877968 6750230 6952599 6672430 6882032 6838851 6867101 6932632 6760851 6903346 6844075 6841316 6876294 6720105 6926843 6907105 6853388 6871526 6901994 6766317 6771060 6705438 6868209 6875145 6901659 6940558 6741831 6730499 6683590 6639227 6683681 6923775 6772434 6916235 6859206 average_num_operations_total=6835092 stdev_num_operations_total=13497 sum_num_operations_total=328084440 min_num_operations_total=6636798 max_num_operations_total=6966014 first_time_thread_terminate_by_thread=10000160 10000173 10000171 10000174 10000161 10000157 10000159 10000160 10000164 10000177 10000161 10000169 10000160 10000157 10000178 10000185 10000167 10000173 10000172 10000188 10000158 10000160 10000158 10000158 10000157 10000160 10000157 10000158 10000173 10000188 10000174 10000160 10000173 10000160 10000158 10000158 10000160 10000157 10000185 10000164 10000174 10000157 10000158 10000166 10000173 10000186 10000164 10000160 min_time_thread_terminate_total=10000157 max_time_thread_terminate_total=10000188 first_time_thread_start_by_thread=5 6 5 5 6 5 5 5 5 5 5 5 5 5 5 5 5 5 6 5 6 5 5 5 5 6 5 5 6 5 5 5 5 5 5 5 5 5 5 5 5 5 6 5 6 5 5 5 min_time_thread_start_total=5 max_time_thread_start_total=6 sum_duration_all_ops_total= threads_final_keysum=10016146457 threads_final_size=100157 final_keysum=10016146457 final_size=100157 validate_result=success Validation OK. Structural validation OK. total_find=0 total_rq=0 total_inserts=164041674 total_deletes=164042766 total_updates=328084440 total_queries=0 total_ops=328084440 find_throughput=0 rq_throughput=0 update_throughput=32808444 query_throughput=0 total_throughput=32808444 total find : 0 total rq : 0 total inserts : 164041674 total deletes : 164042766 total updates : 328084440 total queries : 0 total ops : 328084440 find throughput : 0 rq throughput : 0 update throughput : 32808444 query throughput : 0 total throughput : 32808444 elapsed milliseconds : 10000 napping milliseconds overtime : 100 PAPI_L2_TCM=12.01 PAPI_L3_TCM=0.000546341 PAPI_TOT_CYC=4041.27 PAPI_TOT_INS=2781.94 garbage=0 total_execution_walltime=11.505s REALTIME_MAIN_END_PERF_FORMAT=6991010.366257850 [time_cmd_output] time_elapsed_sec=11.62, faults_major=0, faults_minor=77377, mem_maxresident_kb=311004, user_cputime=559.37, sys_cputime=2.69, percent_cpu=4833% timeout=false algorithm=sigouin_int_avl_kcas_validate.debra thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 millis=10000 __trials=2