__step=000810 __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" ./wang_openbwtree -nwork 48 -nprefill 48 -prefill-hybrid -prefill-hybrid-min-ms 1000 -prefill-hybrid-max-ms 5000 -insdel 50.0 50.0 -k 2000000 -t 10000 -pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 __file_data=data000810.txt __path_data=data/data000810.txt __hostname=jax REALTIME_MAIN_START_PERF_FORMAT=6988748.916283420 binary=./wang_openbwtree parsed custom binding: 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 DS_TYPENAME=wang_openbwtree 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=2000000 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 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.005s prefilling_size=999313 prefilling_elapsed_millis=1.001s finished prefilling to size 999321 for expected size 1000000 keysum=999265642468, performing 15421500 updates; total_prefilling_elapsed_ms=1102 ms) pref_size=999321 pref_millis=1102 prefill_elapsed_ms=1123 main thread: starting timer... ############################################################################### ################################ BEGIN RUNNING ################################ ############################################################################### REALTIME_START_PERF_FORMAT=6988750.230498132 REALTIME_END_PERF_FORMAT=6988760.230639754 ############################################################################### ################################## TIME IS UP ################################# ############################################################################### joining threads... ############################################################################### ################################# END RUNNING ################################# ############################################################################### 10.1s PRODUCING OUTPUT Open BwTree: createTreeStats iterating over all kv-pairs... Open BwTree: createTreeStats finished iterating. tree_stats_computeWalltime=0.024s tree_stats_numInternalsAtDepth=0 tree_stats_numLeavesAtDepth=1 tree_stats_numNodesAtDepth=1 tree_stats_numKeysAtDepth=999620 tree_stats_avgDegreeAtDepth=999620 tree_stats_height=1 tree_stats_numInternals=0 tree_stats_numLeaves=1 tree_stats_numNodes=1 tree_stats_numKeys=999620 tree_stats_avgDegreeInternal=0 tree_stats_avgDegreeLeaves=999620 tree_stats_avgDegree=999621 tree_stats_avgKeyDepth=0 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= first_thread_announced_epoch_by_thread= sum_num_inserts_by_thread=1608526 1609880 1611050 1607605 1614402 1605969 1613800 1611862 1611950 1612251 1609858 1610319 1619398 1617788 1619307 1614221 1609023 1611170 1605542 1611499 1617079 1611773 1612752 1610097 1609538 1607058 1612378 1605014 1615234 1605377 1612068 1615404 1612715 1614223 1610413 1610712 1619310 1617617 1619473 1617709 1611103 1613094 1607284 1614724 1616393 1613130 1615333 1610223 sum_num_inserts_total=77392648 sum_num_deletes_by_thread=1606752 1611040 1610116 1608921 1616285 1603982 1616029 1615373 1610361 1613888 1609788 1608673 1618570 1618385 1620145 1617433 1609033 1609556 1606297 1611606 1616228 1611093 1612446 1609322 1607831 1608599 1613577 1603404 1615456 1604933 1610798 1612210 1610940 1615167 1609300 1613324 1618800 1619405 1616647 1621466 1610861 1615371 1609486 1613750 1617542 1614482 1613296 1609787 sum_num_deletes_total=77397754 sum_num_searches_by_thread= sum_num_searches_total= sum_num_rq_by_thread= sum_num_rq_total= sum_num_operations_by_thread=3215278 3220920 3221166 3216526 3230687 3209951 3229829 3227235 3222311 3226139 3219646 3218992 3237968 3236173 3239452 3231654 3218056 3220726 3211839 3223105 3233307 3222866 3225198 3219419 3217369 3215657 3225955 3208418 3230690 3210310 3222866 3227614 3223655 3229390 3219713 3224036 3238110 3237022 3236120 3239175 3221964 3228465 3216770 3228474 3233935 3227612 3228629 3220010 average_num_operations_total=3224800 stdev_num_operations_total=1174 sum_num_operations_total=154790402 min_num_operations_total=3208418 max_num_operations_total=3239452 first_time_thread_terminate_by_thread=10002696 10003011 10002990 10002276 10000143 10002038 10001989 10002826 10002003 10002466 10002297 10000142 10002717 10000143 10002699 10000142 10002907 10002879 10002715 10002830 10002695 10002843 10002114 10002784 10002765 10002899 10002708 10000142 10002151 10000144 10000143 10002925 10000142 10000142 10000142 10000142 10002686 10002477 10002939 10002190 10002976 10002922 10002912 10002790 10002962 10002737 10000142 10002806 min_time_thread_terminate_total=10000142 max_time_thread_terminate_total=10003011 first_time_thread_start_by_thread=3 2 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 2 2 3 2 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 2 2 min_time_thread_start_total=2 max_time_thread_start_total=3 sum_duration_all_ops_total= threads_final_keysum=999660309788 threads_final_size=999620 final_keysum=999660309788 final_size=999620 validate_result=success Validation OK. Structural validation OK. total_find=0 total_rq=0 total_inserts=77392648 total_deletes=77397754 total_updates=154790402 total_queries=0 total_ops=154790402 find_throughput=0 rq_throughput=0 update_throughput=15479040 query_throughput=0 total_throughput=15479040 total find : 0 total rq : 0 total inserts : 77392648 total deletes : 77397754 total updates : 154790402 total queries : 0 total ops : 154790402 find throughput : 0 rq throughput : 0 update throughput : 15479040 query throughput : 0 total throughput : 15479040 elapsed milliseconds : 10000 napping milliseconds overtime : 100 PAPI_L2_TCM=41.9108 PAPI_L3_TCM=6.84864 PAPI_TOT_CYC=8640.19 PAPI_TOT_INS=1164.96 garbage=0 total_execution_walltime=11.463s REALTIME_MAIN_END_PERF_FORMAT=6988760.380588743 [time_cmd_output] time_elapsed_sec=11.60, faults_major=0, faults_minor=119226, mem_maxresident_kb=468548, user_cputime=549.91, sys_cputime=3.04, percent_cpu=4763% timeout=false algorithm=wang_openbwtree thread_pinning=-pin 0-23,96-119,24-47,120-143,48-71,144-167,72-95,168-191 millis=10000 __trials=2