[2024-12-09 05:02:11.847563] Starting SPDK v25.01-pre git sha1 421ce3854 / DPDK 24.03.0 initialization... [2024-12-09 05:02:11.847726] [ DPDK EAL parameters: rocksdb --no-shconf -c 0x1 --huge-unlink --no-telemetry --log-level=lib.eal:6 --log-level=lib.cryptodev:5 --log-level=lib.power:5 --log-level=user1:6 --base-virtaddr=0x200000000000 --match-allocations --file-prefix=spdk_pid2675912 ] Set seed to 1733716931844017 because --seed was 0 EAL: No free 2048 kB hugepages reported on node 1 [2024-12-09 05:02:11.980110] app.c: 919:spdk_app_start: *NOTICE*: Total cores available: 1 [2024-12-09 05:02:12.086262] app.c: 612:app_setup_trace: *NOTICE*: Tracepoint Group Mask 0x80 specified. [2024-12-09 05:02:12.086327] app.c: 613:app_setup_trace: *NOTICE*: Use 'spdk_trace -s rocksdb -p 2675912' to capture a snapshot of events at runtime. [2024-12-09 05:02:12.086340] app.c: 618:app_setup_trace: *NOTICE*: 'spdk_trace' without parameters will also work if this is the only [2024-12-09 05:02:12.086355] app.c: 619:app_setup_trace: *NOTICE*: SPDK application currently running. [2024-12-09 05:02:12.086365] app.c: 620:app_setup_trace: *NOTICE*: Or copy /dev/shm/rocksdb_trace.pid2675912 for offline analysis/debug. [2024-12-09 05:02:12.087748] reactor.c:1005:reactor_run: *NOTICE*: Reactor started on core 0 RocksDB: version 8.1.1 Date: Mon Dec 9 05:02:15 2024 CPU: 72 * Intel(R) Xeon(R) Gold 6140 CPU @ 2.30GHz CPUCache: 25344 KB 2024/12/09-05:02:18 ... thread 0: (1000000,1000000) ops and (330658.4,330658.4) ops/second in (3.024269,3.024269) seconds ** Compaction Stats [default] ** Level Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) ------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------ L0 9/8 566.20 MB 6.3 0.0 0.0 0.0 0.8 0.8 0.0 1.0 0.0 322.8 2.53 2.37 12 0.211 0 0 0.0 0.0 L1 3/3 188.09 MB 0.0 0.2 0.2 0.0 0.2 0.2 0.1 1.0 242.2 241.6 0.78 0.74 1 0.778 191K 452 0.0 0.0 L2 1/1 100.14 MB 0.0 0.2 0.1 0.1 0.2 0.1 0.0 2.6 255.6 255.1 0.63 0.61 1 0.629 163K 312 0.0 0.0 L3 16/9 753.33 MB 0.1 0.1 0.1 0.0 0.1 0.1 0.0 1.0 202.5 202.5 0.30 0.28 1 0.298 61K 0 0.0 0.0 L4 120/0 9.54 GB 1.0 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 L5 116/0 8.92 GB 0.1 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 Sum 265/21 20.03 GB 0.0 0.4 0.3 0.1 1.2 1.1 0.1 1.5 96.7 289.4 4.24 4.00 15 0.283 416K 764 0.0 0.0 Int 0/0 0.00 KB 0.0 0.4 0.3 0.1 1.2 1.1 0.1 1.5 96.7 289.4 4.24 4.00 15 0.283 416K 764 0.0 0.0 ** Compaction Stats [default] ** Priority Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) --------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------- Low 0/0 0.00 KB 0.0 0.4 0.3 0.1 0.4 0.3 0.0 0.0 240.2 239.7 1.71 1.63 3 0.569 416K 764 0.0 0.0 High 0/0 0.00 KB 0.0 0.0 0.0 0.0 0.8 0.8 0.0 0.0 0.0 322.8 2.53 2.37 12 0.211 0 0 0.0 0.0 Blob file count: 0, total size: 0.0 GB, garbage size: 0.0 GB, space amp: 0.0 Uptime(secs): 3.1 total, 3.0 interval Flush(GB): cumulative 0.799, interval 0.799 AddFile(GB): cumulative 0.000, interval 0.000 AddFile(Total Files): cumulative 0, interval 0 AddFile(L0 Files): cumulative 0, interval 0 AddFile(Keys): cumulative 0, interval 0 Cumulative compaction: 1.20 GB write, 396.66 MB/s write, 0.40 GB read, 132.51 MB/s read, 4.2 seconds Interval compaction: 1.20 GB write, 405.41 MB/s write, 0.40 GB read, 135.43 MB/s read, 4.2 seconds Write Stall (count): cf-l0-file-count-limit-delays-with-ongoing-compaction: 0, cf-l0-file-count-limit-stops-with-ongoing-compaction: 0, l0-file-count-limit-delays: 0, l0-file-count-limit-stops: 0, memtable-limit-delays: 0, memtable-limit-stops: 1, pending-compaction-bytes-delays: 0, pending-compaction-bytes-stops: 0, total-delays: 0, total-stops: 1, interval: 1 total count ** File Read Latency Histogram By Level [default] ** ** Level 0 read latency histogram (micros): Count: 121743 Average: 2.1064 StdDev: 5.74 Min: 1 Median: 1.4229 Max: 1222 Percentiles: P50: 1.42 P75: 1.83 P99: 5.89 P99.9: 13.34 P99.99: 190.55 ------------------------------------------------------ [ 0, 1 ] 29275 24.047% 24.047% ##### ( 1, 2 ] 74720 61.375% 85.422% ############ ( 2, 3 ] 10474 8.603% 94.025% ## ( 3, 4 ] 3586 2.946% 96.971% # ( 4, 6 ] 2617 2.150% 99.120% ( 6, 10 ] 807 0.663% 99.783% ( 10, 15 ] 219 0.180% 99.963% ( 15, 22 ] 28 0.023% 99.986% ( 22, 34 ] 3 0.002% 99.989% ( 51, 76 ] 2 0.002% 99.990% ( 76, 110 ] 1 0.001% 99.991% ( 170, 250 ] 11 0.009% 100.000% ( 250, 380 ] 3 0.002% 100.002% ( 380, 580 ] 9 0.007% 100.010% ( 870, 1300 ] 1 0.001% 100.011% ** Level 1 read latency histogram (micros): Count: 27959 Average: 2.1004 StdDev: 5.25 Min: 0 Median: 1.4409 Max: 655 Percentiles: P50: 1.44 P75: 1.84 P99: 5.66 P99.9: 11.26 P99.99: 218.16 ------------------------------------------------------ [ 0, 1 ] 6266 22.411% 22.411% #### ( 1, 2 ] 17497 62.581% 84.992% ############# ( 2, 3 ] 2534 9.063% 94.056% ## ( 3, 4 ] 893 3.194% 97.250% # ( 4, 6 ] 590 2.110% 99.360% ( 6, 10 ] 145 0.519% 99.878% ( 10, 15 ] 28 0.100% 99.979% ( 15, 22 ] 1 0.004% 99.982% ( 22, 34 ] 1 0.004% 99.986% ( 76, 110 ] 1 0.004% 99.989% ( 170, 250 ] 2 0.007% 99.996% ( 380, 580 ] 1 0.004% 100.000% ( 580, 870 ] 1 0.004% 100.004% ** Level 2 read latency histogram (micros): Count: 40286 Average: 2.6665 StdDev: 28.27 Min: 1 Median: 1.4803 Max: 4431 Percentiles: P50: 1.48 P75: 1.91 P99: 8.82 P99.9: 109.71 P99.99: 379.07 ------------------------------------------------------ [ 0, 1 ] 8807 21.861% 21.861% #### ( 1, 2 ] 23604 58.591% 80.452% ############ ( 2, 3 ] 4176 10.366% 90.818% ## ( 3, 4 ] 1522 3.778% 94.596% # ( 4, 6 ] 1406 3.490% 98.086% # ( 6, 10 ] 522 1.296% 99.382% ( 10, 15 ] 157 0.390% 99.772% ( 15, 22 ] 16 0.040% 99.811% ( 22, 34 ] 2 0.005% 99.816% ( 76, 110 ] 34 0.084% 99.901% ( 110, 170 ] 23 0.057% 99.958% ( 170, 250 ] 9 0.022% 99.980% ( 250, 380 ] 4 0.010% 99.990% ( 380, 580 ] 1 0.002% 99.993% ( 1300, 1900 ] 1 0.002% 99.995% ( 2900, 4400 ] 1 0.002% 99.998% ( 4400, 6600 ] 1 0.002% 100.000% ** Level 3 read latency histogram (micros): Count: 21015 Average: 8.9609 StdDev: 155.82 Min: 1 Median: 1.7966 Max: 8068 Percentiles: P50: 1.80 P75: 2.65 P99: 14.92 P99.9: 2023.13 P99.99: 8068.00 ------------------------------------------------------ [ 0, 1 ] 658 3.131% 3.131% # ( 1, 2 ] 12365 58.839% 61.970% ############ ( 2, 3 ] 4225 20.105% 82.075% #### ( 3, 4 ] 1502 7.147% 89.222% # ( 4, 6 ] 1369 6.514% 95.736% # ( 6, 10 ] 481 2.289% 98.025% ( 10, 15 ] 208 0.990% 99.015% ( 15, 22 ] 28 0.133% 99.148% ( 22, 34 ] 3 0.014% 99.163% ( 34, 51 ] 17 0.081% 99.243% ( 51, 76 ] 15 0.071% 99.315% ( 76, 110 ] 27 0.128% 99.443% ( 110, 170 ] 64 0.305% 99.748% ( 170, 250 ] 7 0.033% 99.781% ( 250, 380 ] 9 0.043% 99.824% ( 380, 580 ] 1 0.005% 99.829% ( 580, 870 ] 3 0.014% 99.843% ( 870, 1300 ] 1 0.005% 99.848% ( 1300, 1900 ] 10 0.048% 99.895% ( 1900, 2900 ] 8 0.038% 99.933% ( 2900, 4400 ] 5 0.024% 99.957% ( 4400, 6600 ] 5 0.024% 99.981% ( 6600, 9900 ] 4 0.019% 100.000% ** Level 4 read latency histogram (micros): Count: 30 Average: 3406.3333 StdDev: 2170.01 Min: 767 Median: 2775.0000 Max: 8887 Percentiles: P50: 2775.00 P75: 4675.00 P99: 8887.00 P99.9: 8887.00 P99.99: 8887.00 ------------------------------------------------------ ( 580, 870 ] 1 3.333% 3.333% # ( 870, 1300 ] 2 6.667% 10.000% # ( 1300, 1900 ] 5 16.667% 26.667% ### ( 1900, 2900 ] 8 26.667% 53.333% ##### ( 2900, 4400 ] 6 20.000% 73.333% #### ( 4400, 6600 ] 4 13.333% 86.667% ### ( 6600, 9900 ] 4 13.333% 100.000% ### ** DB Stats ** Uptime(secs): 3.1 total, 3.0 interval Cumulative writes: 0 writes, 1000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 0.96 GB, 318.20 MB/s Cumulative WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Cumulative stall: 00:00:0.212 H:M:S, 6.9 percent Interval writes: 0 writes, 1000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 984.19 MB, 325.17 MB/s Interval WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Interval stall: 00:00:0.212 H:M:S, 7.0 percent Write Stall (count): write-buffer-manager-limit-stops: 0, num-running-compactions: 3 num-running-flushes: 1 2024/12/09-05:02:21 ... thread 0: (1000000,2000000) ops and (318282.9,324352.7) ops/second in (3.141859,6.166128) seconds ** Compaction Stats [default] ** Level Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) ------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------ L0 11/8 1.29 GB 81.3 0.8 0.0 0.8 2.6 1.8 0.0 1.4 92.7 299.1 8.82 8.34 30 0.294 830K 4236 0.0 0.0 L1 1/0 49.74 MB 5.0 0.6 0.4 0.2 0.6 0.4 0.1 1.4 235.5 233.9 2.67 2.60 2 1.334 638K 4070 0.0 0.0 L2 0/0 0.00 KB 0.0 0.2 0.1 0.1 0.2 0.1 0.4 2.6 255.6 255.1 0.63 0.61 1 0.629 163K 312 0.0 0.0 L3 20/2 978.80 MB 0.7 1.3 0.5 0.8 1.3 0.5 0.0 2.5 227.9 227.3 5.93 5.65 5 1.185 1371K 3469 0.0 0.0 L4 120/0 9.48 GB 1.0 0.0 0.0 0.0 0.0 0.0 0.3 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 L5 120/0 9.23 GB 0.1 0.0 0.0 0.0 0.0 0.0 0.3 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 Sum 272/10 21.00 GB 0.0 2.9 1.0 1.9 4.7 2.8 1.0 2.6 163.9 264.3 18.04 17.20 38 0.475 3003K 12K 0.0 0.0 Int 0/0 0.00 KB 0.0 2.9 1.0 1.9 4.7 2.8 1.0 2.6 163.9 264.3 18.04 17.20 38 0.475 3003K 12K 0.0 0.0 ** Compaction Stats [default] ** Priority Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) --------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------- Low 0/0 0.00 KB 0.0 2.9 1.0 1.9 2.9 1.0 0.0 0.0 234.2 233.2 12.63 12.19 11 1.148 3003K 12K 0.0 0.0 High 0/0 0.00 KB 0.0 0.0 0.0 0.0 1.8 1.8 0.0 0.0 0.0 337.0 5.41 5.00 27 0.200 0 0 0.0 0.0 Blob file count: 0, total size: 0.0 GB, garbage size: 0.0 GB, space amp: 0.0 Uptime(secs): 6.2 total, 6.2 interval Flush(GB): cumulative 1.781, interval 1.781 AddFile(GB): cumulative 0.000, interval 0.000 AddFile(Total Files): cumulative 0, interval 0 AddFile(L0 Files): cumulative 0, interval 0 AddFile(Keys): cumulative 0, interval 0 Cumulative compaction: 4.66 GB write, 764.97 MB/s write, 2.89 GB read, 474.33 MB/s read, 18.0 seconds Interval compaction: 4.66 GB write, 773.24 MB/s write, 2.89 GB read, 479.47 MB/s read, 18.0 seconds Write Stall (count): cf-l0-file-count-limit-delays-with-ongoing-compaction: 0, cf-l0-file-count-limit-stops-with-ongoing-compaction: 0, l0-file-count-limit-delays: 0, l0-file-count-limit-stops: 0, memtable-limit-delays: 0, memtable-limit-stops: 2, pending-compaction-bytes-delays: 0, pending-compaction-bytes-stops: 0, total-delays: 0, total-stops: 2, interval: 2 total count ** File Read Latency Histogram By Level [default] ** ** Level 0 read latency histogram (micros): Count: 397774 Average: 2.5272 StdDev: 6.11 Min: 1 Median: 1.6877 Max: 1455 Percentiles: P50: 1.69 P75: 2.35 P99: 7.05 P99.9: 13.47 P99.99: 18.57 ------------------------------------------------------ [ 0, 1 ] 39768 9.998% 9.998% ## ( 1, 2 ] 231392 58.172% 68.169% ############ ( 2, 3 ] 78577 19.754% 87.924% #### ( 3, 4 ] 23470 5.900% 93.824% # ( 4, 6 ] 19550 4.915% 98.739% # ( 6, 10 ] 3951 0.993% 99.732% ( 10, 15 ] 966 0.243% 99.975% ( 15, 22 ] 122 0.031% 100.006% ( 22, 34 ] 11 0.003% 100.008% ( 34, 51 ] 5 0.001% 100.010% ( 51, 76 ] 6 0.002% 100.011% ( 76, 110 ] 1 0.000% 100.011% ( 170, 250 ] 25 0.006% 100.018% ( 250, 380 ] 5 0.001% 100.019% ( 380, 580 ] 23 0.006% 100.025% ( 580, 870 ] 1 0.000% 100.025% ( 870, 1300 ] 5 0.001% 100.026% ( 1300, 1900 ] 1 0.000% 100.026% ** Level 1 read latency histogram (micros): Count: 145808 Average: 2.9474 StdDev: 7.99 Min: 0 Median: 1.8421 Max: 908 Percentiles: P50: 1.84 P75: 2.67 P99: 8.86 P99.9: 80.97 P99.99: 221.05 ------------------------------------------------------ [ 0, 1 ] 8091 5.549% 5.549% # ( 1, 2 ] 76965 52.785% 58.334% ########### ( 2, 3 ] 36483 25.021% 83.356% ##### ( 3, 4 ] 11016 7.555% 90.911% ## ( 4, 6 ] 10017 6.870% 97.781% # ( 6, 10 ] 2486 1.705% 99.486% ( 10, 15 ] 519 0.356% 99.842% ( 15, 22 ] 77 0.053% 99.894% ( 22, 34 ] 3 0.002% 99.896% ( 34, 51 ] 1 0.001% 99.897% ( 51, 76 ] 2 0.001% 99.898% ( 76, 110 ] 15 0.010% 99.909% ( 110, 170 ] 98 0.067% 99.976% ( 170, 250 ] 32 0.022% 99.998% ( 250, 380 ] 19 0.013% 100.011% ( 380, 580 ] 7 0.005% 100.016% ( 580, 870 ] 4 0.003% 100.019% ( 870, 1300 ] 1 0.001% 100.019% ** Level 2 read latency histogram (micros): Count: 65652 Average: 2.9010 StdDev: 23.28 Min: 1 Median: 1.5893 Max: 4431 Percentiles: P50: 1.59 P75: 2.04 P99: 9.03 P99.9: 159.26 P99.99: 374.75 ------------------------------------------------------ [ 0, 1 ] 9794 14.918% 14.918% ### ( 1, 2 ] 39084 59.532% 74.450% ############ ( 2, 3 ] 9743 14.840% 89.291% ### ( 3, 4 ] 3035 4.623% 93.913% # ( 4, 6 ] 2536 3.863% 97.776% # ( 6, 10 ] 1059 1.613% 99.389% ( 10, 15 ] 202 0.308% 99.697% ( 15, 22 ] 20 0.030% 99.727% ( 22, 34 ] 2 0.003% 99.730% ( 34, 51 ] 1 0.002% 99.732% ( 76, 110 ] 34 0.052% 99.784% ( 110, 170 ] 93 0.142% 99.925% ( 170, 250 ] 29 0.044% 99.970% ( 250, 380 ] 14 0.021% 99.991% ( 380, 580 ] 3 0.005% 99.995% ( 1300, 1900 ] 1 0.002% 99.997% ( 2900, 4400 ] 1 0.002% 99.998% ( 4400, 6600 ] 1 0.002% 100.000% ** Level 3 read latency histogram (micros): Count: 220461 Average: 3.8197 StdDev: 49.35 Min: 1 Median: 1.8066 Max: 8068 Percentiles: P50: 1.81 P75: 2.61 P99: 9.94 P99.9: 168.60 P99.99: 433.49 ------------------------------------------------------ [ 0, 1 ] 8323 3.775% 3.775% # ( 1, 2 ] 126346 57.310% 61.085% ########### ( 2, 3 ] 50524 22.917% 84.003% ##### ( 3, 4 ] 15022 6.814% 90.817% # ( 4, 6 ] 13252 6.011% 96.828% # ( 6, 10 ] 4862 2.205% 99.033% ( 10, 15 ] 1054 0.478% 99.511% ( 15, 22 ] 167 0.076% 99.587% ( 22, 34 ] 18 0.008% 99.595% ( 34, 51 ] 130 0.059% 99.654% ( 51, 76 ] 96 0.044% 99.697% ( 76, 110 ] 95 0.043% 99.741% ( 110, 170 ] 362 0.164% 99.905% ( 170, 250 ] 113 0.051% 99.956% ( 250, 380 ] 70 0.032% 99.988% ( 380, 580 ] 26 0.012% 100.000% ( 580, 870 ] 8 0.004% 100.003% ( 870, 1300 ] 3 0.001% 100.005% ( 1300, 1900 ] 10 0.005% 100.009% ( 1900, 2900 ] 8 0.004% 100.013% ( 2900, 4400 ] 5 0.002% 100.015% ( 4400, 6600 ] 5 0.002% 100.017% ( 6600, 9900 ] 4 0.002% 100.019% ** Level 4 read latency histogram (micros): Count: 30 Average: 3406.3333 StdDev: 2170.01 Min: 767 Median: 2775.0000 Max: 8887 Percentiles: P50: 2775.00 P75: 4675.00 P99: 8887.00 P99.9: 8887.00 P99.99: 8887.00 ------------------------------------------------------ ( 580, 870 ] 1 3.333% 3.333% # ( 870, 1300 ] 2 6.667% 10.000% # ( 1300, 1900 ] 5 16.667% 26.667% ### ( 1900, 2900 ] 8 26.667% 53.333% ##### ( 2900, 4400 ] 6 20.000% 73.333% #### ( 4400, 6600 ] 4 13.333% 86.667% ### ( 6600, 9900 ] 4 13.333% 100.000% ### ** Level 5 read latency histogram (micros): Count: 20 Average: 474.0000 StdDev: 494.53 Min: 104 Median: 236.6667 Max: 2092 Percentiles: P50: 236.67 P75: 580.00 P99: 2092.00 P99.9: 2092.00 P99.99: 2092.00 ------------------------------------------------------ ( 76, 110 ] 1 5.000% 5.000% # ( 110, 170 ] 4 20.000% 25.000% #### ( 170, 250 ] 6 30.000% 55.000% ###### ( 250, 380 ] 3 15.000% 70.000% ### ( 380, 580 ] 1 5.000% 75.000% # ( 870, 1300 ] 4 20.000% 95.000% #### ( 1900, 2900 ] 1 5.000% 100.000% # ** DB Stats ** Uptime(secs): 6.2 total, 3.1 interval Cumulative writes: 0 writes, 2000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 1.92 GB, 315.71 MB/s Cumulative WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Cumulative stall: 00:00:0.391 H:M:S, 6.3 percent Interval writes: 0 writes, 1000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 984.19 MB, 313.26 MB/s Interval WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Interval stall: 00:00:0.179 H:M:S, 5.7 percent Write Stall (count): write-buffer-manager-limit-stops: 0, num-running-compactions: 4 num-running-flushes: 1 2024/12/09-05:02:24 ... thread 0: (1000000,3000000) ops and (326885.8,325192.7) ops/second in (3.059172,9.225300) seconds ** Compaction Stats [default] ** Level Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) ------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------ L0 14/4 2.26 GB 206.6 1.8 0.0 1.8 4.6 2.8 0.0 1.7 117.7 293.7 16.03 15.24 49 0.327 1916K 9810 0.0 0.0 L1 1/0 49.74 MB 5.0 0.6 0.4 0.2 0.6 0.4 0.1 1.4 235.5 233.9 2.67 2.60 2 1.334 638K 4070 0.0 0.0 L2 0/0 0.00 KB 0.0 0.2 0.1 0.1 0.2 0.1 0.4 2.6 255.6 255.1 0.63 0.61 1 0.629 163K 312 0.0 0.0 L3 18/0 748.05 MB 0.7 1.3 0.5 0.8 1.3 0.5 0.0 2.5 227.9 227.3 5.93 5.65 5 1.185 1371K 3469 0.0 0.0 L4 127/0 9.70 GB 1.0 0.2 0.2 0.0 0.2 0.2 0.3 1.0 212.1 212.1 1.09 1.05 2 0.544 234K 0 0.0 0.0 L5 120/0 9.23 GB 0.1 0.0 0.0 0.0 0.0 0.0 0.3 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 Sum 280/4 21.97 GB 0.0 4.2 1.3 2.9 6.9 4.0 1.0 2.5 161.6 268.4 26.34 25.14 59 0.446 4323K 17K 0.0 0.0 Int 0/0 0.00 KB 0.0 4.2 1.3 2.9 6.9 4.0 1.0 2.5 161.6 268.4 26.34 25.14 59 0.446 4323K 17K 0.0 0.0 ** Compaction Stats [default] ** Priority Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) --------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------- Low 0/0 0.00 KB 0.0 4.2 1.3 2.9 4.1 1.2 0.0 0.0 235.7 234.7 18.06 17.51 17 1.062 4323K 17K 0.0 0.0 High 0/0 0.00 KB 0.0 0.0 0.0 0.0 2.8 2.8 0.0 0.0 0.0 342.1 8.28 7.63 42 0.197 0 0 0.0 0.0 Blob file count: 0, total size: 0.0 GB, garbage size: 0.0 GB, space amp: 0.0 Uptime(secs): 9.3 total, 9.2 interval Flush(GB): cumulative 2.764, interval 2.764 AddFile(GB): cumulative 0.000, interval 0.000 AddFile(Total Files): cumulative 0, interval 0 AddFile(L0 Files): cumulative 0, interval 0 AddFile(Keys): cumulative 0, interval 0 Cumulative compaction: 6.90 GB write, 760.74 MB/s write, 4.16 GB read, 458.09 MB/s read, 26.3 seconds Interval compaction: 6.90 GB write, 766.24 MB/s write, 4.16 GB read, 461.40 MB/s read, 26.3 seconds Write Stall (count): cf-l0-file-count-limit-delays-with-ongoing-compaction: 0, cf-l0-file-count-limit-stops-with-ongoing-compaction: 0, l0-file-count-limit-delays: 0, l0-file-count-limit-stops: 0, memtable-limit-delays: 0, memtable-limit-stops: 3, pending-compaction-bytes-delays: 0, pending-compaction-bytes-stops: 0, total-delays: 0, total-stops: 3, interval: 3 total count ** File Read Latency Histogram By Level [default] ** ** Level 0 read latency histogram (micros): Count: 647102 Average: 2.3949 StdDev: 6.79 Min: 1 Median: 1.6097 Max: 2090 Percentiles: P50: 1.61 P75: 2.07 P99: 6.19 P99.9: 13.10 P99.99: 19.22 ------------------------------------------------------ [ 0, 1 ] 82438 12.740% 12.740% ### ( 1, 2 ] 395482 61.116% 73.855% ############ ( 2, 3 ] 107913 16.676% 90.532% ### ( 3, 4 ] 30478 4.710% 95.242% # ( 4, 6 ] 24067 3.719% 98.961% # ( 6, 10 ] 5283 0.816% 99.777% ( 10, 15 ] 1281 0.198% 99.975% ( 15, 22 ] 158 0.024% 100.000% ( 22, 34 ] 14 0.002% 100.002% ( 34, 51 ] 6 0.001% 100.003% ( 51, 76 ] 7 0.001% 100.004% ( 76, 110 ] 1 0.000% 100.004% ( 170, 250 ] 39 0.006% 100.010% ( 250, 380 ] 13 0.002% 100.012% ( 380, 580 ] 32 0.005% 100.017% ( 580, 870 ] 2 0.000% 100.017% ( 870, 1300 ] 11 0.002% 100.019% ( 1300, 1900 ] 1 0.000% 100.019% ( 1900, 2900 ] 1 0.000% 100.019% ** Level 1 read latency histogram (micros): Count: 145808 Average: 2.9474 StdDev: 7.99 Min: 0 Median: 1.8421 Max: 908 Percentiles: P50: 1.84 P75: 2.67 P99: 8.86 P99.9: 80.97 P99.99: 221.05 ------------------------------------------------------ [ 0, 1 ] 8091 5.549% 5.549% # ( 1, 2 ] 76965 52.785% 58.334% ########### ( 2, 3 ] 36483 25.021% 83.356% ##### ( 3, 4 ] 11016 7.555% 90.911% ## ( 4, 6 ] 10017 6.870% 97.781% # ( 6, 10 ] 2486 1.705% 99.486% ( 10, 15 ] 519 0.356% 99.842% ( 15, 22 ] 77 0.053% 99.894% ( 22, 34 ] 3 0.002% 99.896% ( 34, 51 ] 1 0.001% 99.897% ( 51, 76 ] 2 0.001% 99.898% ( 76, 110 ] 15 0.010% 99.909% ( 110, 170 ] 98 0.067% 99.976% ( 170, 250 ] 32 0.022% 99.998% ( 250, 380 ] 19 0.013% 100.011% ( 380, 580 ] 7 0.005% 100.016% ( 580, 870 ] 4 0.003% 100.019% ( 870, 1300 ] 1 0.001% 100.019% ** Level 2 read latency histogram (micros): Count: 65652 Average: 2.9010 StdDev: 23.28 Min: 1 Median: 1.5893 Max: 4431 Percentiles: P50: 1.59 P75: 2.04 P99: 9.03 P99.9: 159.26 P99.99: 374.75 ------------------------------------------------------ [ 0, 1 ] 9794 14.918% 14.918% ### ( 1, 2 ] 39084 59.532% 74.450% ############ ( 2, 3 ] 9743 14.840% 89.291% ### ( 3, 4 ] 3035 4.623% 93.913% # ( 4, 6 ] 2536 3.863% 97.776% # ( 6, 10 ] 1059 1.613% 99.389% ( 10, 15 ] 202 0.308% 99.697% ( 15, 22 ] 20 0.030% 99.727% ( 22, 34 ] 2 0.003% 99.730% ( 34, 51 ] 1 0.002% 99.732% ( 76, 110 ] 34 0.052% 99.784% ( 110, 170 ] 93 0.142% 99.925% ( 170, 250 ] 29 0.044% 99.970% ( 250, 380 ] 14 0.021% 99.991% ( 380, 580 ] 3 0.005% 99.995% ( 1300, 1900 ] 1 0.002% 99.997% ( 2900, 4400 ] 1 0.002% 99.998% ( 4400, 6600 ] 1 0.002% 100.000% ** Level 3 read latency histogram (micros): Count: 262716 Average: 3.6529 StdDev: 45.22 Min: 1 Median: 1.8209 Max: 8068 Percentiles: P50: 1.82 P75: 2.62 P99: 9.82 P99.9: 157.28 P99.99: 336.78 ------------------------------------------------------ [ 0, 1 ] 8836 3.363% 3.363% # ( 1, 2 ] 149245 56.808% 60.172% ########### ( 2, 3 ] 63214 24.062% 84.234% ##### ( 3, 4 ] 17769 6.764% 90.997% # ( 4, 6 ] 15671 5.965% 96.962% # ( 6, 10 ] 5600 2.132% 99.094% ( 10, 15 ] 1279 0.487% 99.581% ( 15, 22 ] 210 0.080% 99.660% ( 22, 34 ] 22 0.008% 99.669% ( 34, 51 ] 131 0.050% 99.719% ( 51, 76 ] 96 0.037% 99.755% ( 76, 110 ] 95 0.036% 99.791% ( 110, 170 ] 362 0.138% 99.929% ( 170, 250 ] 113 0.043% 99.972% ( 250, 380 ] 70 0.027% 99.999% ( 380, 580 ] 26 0.010% 100.009% ( 580, 870 ] 8 0.003% 100.012% ( 870, 1300 ] 3 0.001% 100.013% ( 1300, 1900 ] 10 0.004% 100.017% ( 1900, 2900 ] 8 0.003% 100.020% ( 2900, 4400 ] 5 0.002% 100.022% ( 4400, 6600 ] 5 0.002% 100.024% ( 6600, 9900 ] 4 0.002% 100.025% ** Level 4 read latency histogram (micros): Count: 65 Average: 1608.5846 StdDev: 2225.25 Min: 1 Median: 230.0000 Max: 8887 Percentiles: P50: 230.00 P75: 2618.75 P99: 8887.00 P99.9: 8887.00 P99.99: 8887.00 ------------------------------------------------------ [ 0, 1 ] 10 15.385% 15.385% ### ( 1, 2 ] 9 13.846% 29.231% ### ( 2, 3 ] 2 3.077% 32.308% # ( 6, 10 ] 1 1.538% 33.846% ( 10, 15 ] 1 1.538% 35.385% ( 22, 34 ] 1 1.538% 36.923% ( 34, 51 ] 1 1.538% 38.462% ( 76, 110 ] 1 1.538% 40.000% ( 110, 170 ] 5 7.692% 47.692% ## ( 170, 250 ] 2 3.077% 50.769% # ( 250, 380 ] 1 1.538% 52.308% ( 580, 870 ] 2 3.077% 55.385% # ( 870, 1300 ] 2 3.077% 58.462% # ( 1300, 1900 ] 5 7.692% 66.154% ## ( 1900, 2900 ] 8 12.308% 78.462% ## ( 2900, 4400 ] 6 9.231% 87.692% ## ( 4400, 6600 ] 4 6.154% 93.846% # ( 6600, 9900 ] 4 6.154% 100.000% # ** Level 5 read latency histogram (micros): Count: 20 Average: 474.0000 StdDev: 494.53 Min: 104 Median: 236.6667 Max: 2092 Percentiles: P50: 236.67 P75: 580.00 P99: 2092.00 P99.9: 2092.00 P99.99: 2092.00 ------------------------------------------------------ ( 76, 110 ] 1 5.000% 5.000% # ( 110, 170 ] 4 20.000% 25.000% #### ( 170, 250 ] 6 30.000% 55.000% ###### ( 250, 380 ] 3 15.000% 70.000% ### ( 380, 580 ] 1 5.000% 75.000% # ( 870, 1300 ] 4 20.000% 95.000% #### ( 1900, 2900 ] 1 5.000% 100.000% # ** DB Stats ** Uptime(secs): 9.3 total, 3.1 interval Cumulative writes: 0 writes, 3000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 2.88 GB, 317.69 MB/s Cumulative WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Cumulative stall: 00:00:0.610 H:M:S, 6.6 percent Interval writes: 0 writes, 1000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 984.19 MB, 321.72 MB/s Interval WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Interval stall: 00:00:0.219 H:M:S, 7.1 percent Write Stall (count): write-buffer-manager-limit-stops: 0, num-running-compactions: 1 num-running-flushes: 1 2024/12/09-05:02:27 ... thread 0: (1000000,4000000) ops and (336737.5,328004.0) ops/second in (2.969672,12.194972) seconds ** Compaction Stats [default] ** Level Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) ------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------ L0 19/18 3.18 GB 6.3 2.6 0.0 2.6 6.3 3.7 0.0 1.7 122.4 296.6 21.58 20.56 66 0.327 2682K 13K 0.0 0.0 L1 1/1 49.74 MB 0.0 0.6 0.4 0.2 0.6 0.4 0.1 1.4 235.5 233.9 2.67 2.60 2 1.334 638K 4070 0.0 0.0 L2 0/0 0.00 KB 0.0 0.2 0.1 0.1 0.2 0.1 0.4 2.6 255.6 255.1 0.63 0.61 1 0.629 163K 312 0.0 0.0 L3 18/0 748.05 MB 0.7 1.3 0.5 0.8 1.3 0.5 0.0 2.5 227.9 227.3 5.93 5.65 5 1.185 1371K 3469 0.0 0.0 L4 127/0 9.70 GB 1.0 0.2 0.2 0.0 0.2 0.2 0.3 1.0 212.1 212.1 1.09 1.05 2 0.544 234K 0 0.0 0.0 L5 120/0 9.23 GB 0.1 0.0 0.0 0.0 0.0 0.0 0.3 0.0 0.0 0.0 0.00 0.00 0 0.000 0 0 0.0 0.0 Sum 285/19 22.89 GB 0.0 4.9 1.3 3.6 8.6 4.9 1.0 2.3 157.2 274.8 31.89 30.46 76 0.420 5090K 21K 0.0 0.0 Int 0/0 0.00 KB 0.0 4.9 1.3 3.6 8.6 4.9 1.0 2.3 157.2 274.8 31.89 30.46 76 0.420 5090K 21K 0.0 0.0 ** Compaction Stats [default] ** Priority Files Size Score Read(GB) Rn(GB) Rnp1(GB) Write(GB) Wnew(GB) Moved(GB) W-Amp Rd(MB/s) Wr(MB/s) Comp(sec) CompMergeCPU(sec) Comp(cnt) Avg(sec) KeyIn KeyDrop Rblob(GB) Wblob(GB) --------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------------- Low 0/0 0.00 KB 0.0 4.9 1.3 3.6 4.9 1.2 0.0 0.0 238.7 237.7 20.99 20.39 20 1.050 5090K 21K 0.0 0.0 High 0/0 0.00 KB 0.0 0.0 0.0 0.0 3.7 3.7 0.0 0.0 0.0 346.2 10.90 10.07 56 0.195 0 0 0.0 0.0 Blob file count: 0, total size: 0.0 GB, garbage size: 0.0 GB, space amp: 0.0 Uptime(secs): 12.3 total, 12.2 interval Flush(GB): cumulative 3.686, interval 3.686 AddFile(GB): cumulative 0.000, interval 0.000 AddFile(Total Files): cumulative 0, interval 0 AddFile(L0 Files): cumulative 0, interval 0 AddFile(Keys): cumulative 0, interval 0 Cumulative compaction: 8.56 GB write, 714.71 MB/s write, 4.89 GB read, 408.73 MB/s read, 31.9 seconds Interval compaction: 8.56 GB write, 718.62 MB/s write, 4.89 GB read, 410.96 MB/s read, 31.9 seconds Write Stall (count): cf-l0-file-count-limit-delays-with-ongoing-compaction: 0, cf-l0-file-count-limit-stops-with-ongoing-compaction: 0, l0-file-count-limit-delays: 0, l0-file-count-limit-stops: 0, memtable-limit-delays: 0, memtable-limit-stops: 5, pending-compaction-bytes-delays: 0, pending-compaction-bytes-stops: 0, total-delays: 0, total-stops: 5, interval: 5 total count ** File Read Latency Histogram By Level [default] ** ** Level 0 read latency histogram (micros): Count: 878788 Average: 2.3858 StdDev: 7.57 Min: 0 Median: 1.5720 Max: 2090 Percentiles: P50: 1.57 P75: 1.97 P99: 6.00 P99.9: 14.11 P99.99: 159.84 ------------------------------------------------------ [ 0, 1 ] 122855 13.980% 13.980% ### ( 1, 2 ] 553410 62.974% 76.954% ############# ( 2, 3 ] 130940 14.900% 91.854% ### ( 3, 4 ] 35921 4.088% 95.942% # ( 4, 6 ] 26918 3.063% 99.005% # ( 6, 10 ] 6602 0.751% 99.756% ( 10, 15 ] 1543 0.176% 99.932% ( 15, 22 ] 197 0.022% 99.954% ( 22, 34 ] 19 0.002% 99.956% ( 34, 51 ] 6 0.001% 99.957% ( 51, 76 ] 9 0.001% 99.958% ( 76, 110 ] 10 0.001% 99.959% ( 110, 170 ] 330 0.038% 99.997% ( 170, 250 ] 82 0.009% 100.006% ( 250, 380 ] 28 0.003% 100.009% ( 380, 580 ] 40 0.005% 100.014% ( 580, 870 ] 4 0.000% 100.014% ( 870, 1300 ] 17 0.002% 100.016% ( 1300, 1900 ] 2 0.000% 100.016% ( 1900, 2900 ] 1 0.000% 100.017% ** Level 1 read latency histogram (micros): Count: 145809 Average: 2.9484 StdDev: 8.00 Min: 0 Median: 1.8421 Max: 908 Percentiles: P50: 1.84 P75: 2.67 P99: 8.86 P99.9: 83.23 P99.99: 221.05 ------------------------------------------------------ [ 0, 1 ] 8091 5.549% 5.549% # ( 1, 2 ] 76965 52.785% 58.334% ########### ( 2, 3 ] 36483 25.021% 83.355% ##### ( 3, 4 ] 11016 7.555% 90.910% ## ( 4, 6 ] 10017 6.870% 97.780% # ( 6, 10 ] 2486 1.705% 99.485% ( 10, 15 ] 519 0.356% 99.841% ( 15, 22 ] 77 0.053% 99.894% ( 22, 34 ] 3 0.002% 99.896% ( 34, 51 ] 1 0.001% 99.896% ( 51, 76 ] 2 0.001% 99.898% ( 76, 110 ] 15 0.010% 99.908% ( 110, 170 ] 99 0.068% 99.976% ( 170, 250 ] 32 0.022% 99.998% ( 250, 380 ] 19 0.013% 100.011% ( 380, 580 ] 7 0.005% 100.016% ( 580, 870 ] 4 0.003% 100.019% ( 870, 1300 ] 1 0.001% 100.019% ** Level 2 read latency histogram (micros): Count: 65652 Average: 2.9010 StdDev: 23.28 Min: 1 Median: 1.5893 Max: 4431 Percentiles: P50: 1.59 P75: 2.04 P99: 9.03 P99.9: 159.26 P99.99: 374.75 ------------------------------------------------------ [ 0, 1 ] 9794 14.918% 14.918% ### ( 1, 2 ] 39084 59.532% 74.450% ############ ( 2, 3 ] 9743 14.840% 89.291% ### ( 3, 4 ] 3035 4.623% 93.913% # ( 4, 6 ] 2536 3.863% 97.776% # ( 6, 10 ] 1059 1.613% 99.389% ( 10, 15 ] 202 0.308% 99.697% ( 15, 22 ] 20 0.030% 99.727% ( 22, 34 ] 2 0.003% 99.730% ( 34, 51 ] 1 0.002% 99.732% ( 76, 110 ] 34 0.052% 99.784% ( 110, 170 ] 93 0.142% 99.925% ( 170, 250 ] 29 0.044% 99.970% ( 250, 380 ] 14 0.021% 99.991% ( 380, 580 ] 3 0.005% 99.995% ( 1300, 1900 ] 1 0.002% 99.997% ( 2900, 4400 ] 1 0.002% 99.998% ( 4400, 6600 ] 1 0.002% 100.000% ** Level 3 read latency histogram (micros): Count: 262716 Average: 3.6529 StdDev: 45.22 Min: 1 Median: 1.8209 Max: 8068 Percentiles: P50: 1.82 P75: 2.62 P99: 9.82 P99.9: 157.28 P99.99: 336.78 ------------------------------------------------------ [ 0, 1 ] 8836 3.363% 3.363% # ( 1, 2 ] 149245 56.808% 60.172% ########### ( 2, 3 ] 63214 24.062% 84.234% ##### ( 3, 4 ] 17769 6.764% 90.997% # ( 4, 6 ] 15671 5.965% 96.962% # ( 6, 10 ] 5600 2.132% 99.094% ( 10, 15 ] 1279 0.487% 99.581% ( 15, 22 ] 210 0.080% 99.660% ( 22, 34 ] 22 0.008% 99.669% ( 34, 51 ] 131 0.050% 99.719% ( 51, 76 ] 96 0.037% 99.755% ( 76, 110 ] 95 0.036% 99.791% ( 110, 170 ] 362 0.138% 99.929% ( 170, 250 ] 113 0.043% 99.972% ( 250, 380 ] 70 0.027% 99.999% ( 380, 580 ] 26 0.010% 100.009% ( 580, 870 ] 8 0.003% 100.012% ( 870, 1300 ] 3 0.001% 100.013% ( 1300, 1900 ] 10 0.004% 100.017% ( 1900, 2900 ] 8 0.003% 100.020% ( 2900, 4400 ] 5 0.002% 100.022% ( 4400, 6600 ] 5 0.002% 100.024% ( 6600, 9900 ] 4 0.002% 100.025% ** Level 4 read latency histogram (micros): Count: 65 Average: 1608.5846 StdDev: 2225.25 Min: 1 Median: 230.0000 Max: 8887 Percentiles: P50: 230.00 P75: 2618.75 P99: 8887.00 P99.9: 8887.00 P99.99: 8887.00 ------------------------------------------------------ [ 0, 1 ] 10 15.385% 15.385% ### ( 1, 2 ] 9 13.846% 29.231% ### ( 2, 3 ] 2 3.077% 32.308% # ( 6, 10 ] 1 1.538% 33.846% ( 10, 15 ] 1 1.538% 35.385% ( 22, 34 ] 1 1.538% 36.923% ( 34, 51 ] 1 1.538% 38.462% ( 76, 110 ] 1 1.538% 40.000% ( 110, 170 ] 5 7.692% 47.692% ## ( 170, 250 ] 2 3.077% 50.769% # ( 250, 380 ] 1 1.538% 52.308% ( 580, 870 ] 2 3.077% 55.385% # ( 870, 1300 ] 2 3.077% 58.462% # ( 1300, 1900 ] 5 7.692% 66.154% ## ( 1900, 2900 ] 8 12.308% 78.462% ## ( 2900, 4400 ] 6 9.231% 87.692% ## ( 4400, 6600 ] 4 6.154% 93.846% # ( 6600, 9900 ] 4 6.154% 100.000% # ** Level 5 read latency histogram (micros): Count: 20 Average: 474.0000 StdDev: 494.53 Min: 104 Median: 236.6667 Max: 2092 Percentiles: P50: 236.67 P75: 580.00 P99: 2092.00 P99.9: 2092.00 P99.99: 2092.00 ------------------------------------------------------ ( 76, 110 ] 1 5.000% 5.000% # ( 110, 170 ] 4 20.000% 25.000% #### ( 170, 250 ] 6 30.000% 55.000% ###### ( 250, 380 ] 3 15.000% 70.000% ### ( 380, 580 ] 1 5.000% 75.000% # ( 870, 1300 ] 4 20.000% 95.000% #### ( 1900, 2900 ] 1 5.000% 100.000% # ** DB Stats ** Uptime(secs): 12.3 total, 3.0 interval Cumulative writes: 0 writes, 4000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 3.84 GB, 321.01 MB/s Cumulative WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Cumulative stall: 00:00:0.782 H:M:S, 6.4 percent Interval writes: 0 writes, 1000K keys, 0 commit groups, 0.0 writes per commit group, ingest: 984.19 MB, 331.41 MB/s Interval WAL: 0 writes, 0 syncs, 0.00 writes per sync, written: 0.00 GB, 0.00 MB/s Interval stall: 00:00:0.172 H:M:S, 5.8 percent Write Stall (count): write-buffer-manager-limit-stops: 0, num-running-compactions: 2 num-running-flushes: 1 using bdev Nvme0n1 Initializing RocksDB Options from the specified file Initializing RocksDB Options from command-line flags Integrated BlobDB: blob cache disabled Keys: 16 bytes each (+ 0 bytes user-defined timestamp) Values: 1000 bytes each (1000 bytes after compression) Entries: 20000000 Prefix: 0 bytes Keys per prefix: 0 RawSize: 19378.7 MB (estimated) FileSize: 19378.7 MB (estimated) Write rate: 0 bytes/second Read rate: 0 ops/second Compression: NoCompression Compression sampling rate: 0 Memtablerep: SkipListFactory Perf Level: 1 ------------------------------------------------ DB path: [/mnt/rocksdb] overwrite : 4.222 micros/op 236868 ops/sec 20.074 seconds 4754999 operations; 229.5 MB/s Microseconds per write: Count: 4754999 Average: 4.2217 StdDev: 185.29 Min: 0 Median: 1.7672 Max: 218811 Percentiles: P50: 1.77 P75: 3.08 P99: 9.20 P99.9: 181.07 P99.99: 2288.96 ------------------------------------------------------ [ 0, 1 ] 679058 14.281% 14.281% ### ( 1, 2 ] 2213850 46.558% 60.839% ######### ( 2, 3 ] 618967 13.017% 73.856% ### ( 3, 4 ] 644056 13.545% 87.401% ### ( 4, 6 ] 496662 10.445% 97.846% ## ( 6, 10 ] 68500 1.441% 99.287% ( 10, 15 ] 17660 0.371% 99.658% ( 15, 22 ] 5282 0.111% 99.769% ( 22, 34 ] 1511 0.032% 99.801% ( 34, 51 ] 245 0.005% 99.806% ( 51, 76 ] 30 0.001% 99.807% ( 76, 110 ] 4 0.000% 99.807% ( 110, 170 ] 4370 0.092% 99.899% ( 170, 250 ] 354 0.007% 99.906% ( 250, 380 ] 89 0.002% 99.908% ( 380, 580 ] 13 0.000% 99.909% ( 580, 870 ] 5 0.000% 99.909% ( 870, 1300 ] 3562 0.075% 99.984% ( 1300, 1900 ] 6 0.000% 99.984% ( 1900, 2900 ] 770 0.016% 100.000% ( 22000, 33000 ] 1 0.000% 100.000% ( 170000, 250000 ] 4 0.000% 100.000% STATISTICS: rocksdb.block.cache.miss COUNT : 0 rocksdb.block.cache.hit COUNT : 0 rocksdb.block.cache.add COUNT : 0 rocksdb.block.cache.add.failures COUNT : 0 rocksdb.block.cache.index.miss COUNT : 0 rocksdb.block.cache.index.hit COUNT : 0 rocksdb.block.cache.index.add COUNT : 0 rocksdb.block.cache.index.bytes.insert COUNT : 0 rocksdb.block.cache.filter.miss COUNT : 0 rocksdb.block.cache.filter.hit COUNT : 0 rocksdb.block.cache.filter.add COUNT : 0 rocksdb.block.cache.filter.bytes.insert COUNT : 0 rocksdb.block.cache.data.miss COUNT : 0 rocksdb.block.cache.data.hit COUNT : 0 rocksdb.block.cache.data.add COUNT : 0 rocksdb.block.cache.data.bytes.insert COUNT : 0 rocksdb.block.cache.bytes.read COUNT : 0 rocksdb.block.cache.bytes.write COUNT : 0 rocksdb.bloom.filter.useful COUNT : 0 rocksdb.bloom.filter.full.positive COUNT : 0 rocksdb.bloom.filter.full.true.positive COUNT : 0 rocksdb.persistent.cache.hit COUNT : 0 rocksdb.persistent.cache.miss COUNT : 0 rocksdb.sim.block.cache.hit COUNT : 0 rocksdb.sim.block.cache.miss COUNT : 0 rocksdb.memtable.hit COUNT : 0 rocksdb.memtable.miss COUNT : 0 rocksdb.l0.hit COUNT : 0 rocksdb.l1.hit COUNT : 0 rocksdb.l2andup.hit COUNT : 0 rocksdb.compaction.key.drop.new COUNT : 162951 rocksdb.compaction.key.drop.obsolete COUNT : 0 rocksdb.compaction.key.drop.range_del COUNT : 0 rocksdb.compaction.key.drop.user COUNT : 0 rocksdb.compaction.range_del.drop.obsolete COUNT : 0 rocksdb.compaction.optimized.del.drop.obsolete COUNT : 0 rocksdb.compaction.cancelled COUNT : 0 rocksdb.number.keys.written COUNT : 4754999 rocksdb.number.keys.read COUNT : 0 rocksdb.number.keys.updated COUNT : 0 rocksdb.bytes.written COUNT : 4907158968 rocksdb.bytes.read COUNT : 0 rocksdb.number.db.seek COUNT : 0 rocksdb.number.db.next COUNT : 0 rocksdb.number.db.prev COUNT : 0 rocksdb.number.db.seek.found COUNT : 0 rocksdb.number.db.next.found COUNT : 0 rocksdb.number.db.prev.found COUNT : 0 rocksdb.db.iter.bytes.read COUNT : 0 rocksdb.no.file.opens COUNT : 153 rocksdb.no.file.errors COUNT : 0 rocksdb.stall.micros COUNT : 6229250 rocksdb.db.mutex.wait.micros COUNT : 0 rocksdb.number.multiget.get COUNT : 0 rocksdb.number.multiget.keys.read COUNT : 0 rocksdb.number.multiget.bytes.read COUNT : 0 rocksdb.number.merge.failures COUNT : 0 rocksdb.bloom.filter.prefix.checked COUNT : 0 rocksdb.bloom.filter.prefix.useful COUNT : 0 rocksdb.number.reseeks.iteration COUNT : 0 rocksdb.getupdatessince.calls COUNT : 0 rocksdb.wal.synced COUNT : 0 rocksdb.wal.bytes COUNT : 0 rocksdb.write.self COUNT : 0 rocksdb.write.other COUNT : 0 rocksdb.write.wal COUNT : 0 rocksdb.compact.read.bytes COUNT : 9108843731 rocksdb.compact.write.bytes COUNT : 8950443740 rocksdb.flush.write.bytes COUNT : 4880926254 rocksdb.compact.read.marked.bytes COUNT : 0 rocksdb.compact.read.periodic.bytes COUNT : 0 rocksdb.compact.read.ttl.bytes COUNT : 0 rocksdb.compact.write.marked.bytes COUNT : 0 rocksdb.compact.write.periodic.bytes COUNT : 0 rocksdb.compact.write.ttl.bytes COUNT : 0 rocksdb.number.direct.load.table.properties COUNT : 14 rocksdb.number.superversion_acquires COUNT : 0 rocksdb.number.superversion_releases COUNT : 0 rocksdb.number.superversion_cleanups COUNT : 0 rocksdb.number.block.compressed COUNT : 0 rocksdb.number.block.decompressed COUNT : 0 rocksdb.number.block.not_compressed COUNT : 0 rocksdb.merge.operation.time.nanos COUNT : 0 rocksdb.filter.operation.time.nanos COUNT : 0 rocksdb.row.cache.hit COUNT : 0 rocksdb.row.cache.miss COUNT : 0 rocksdb.read.amp.estimate.useful.bytes COUNT : 0 rocksdb.read.amp.total.read.bytes COUNT : 0 rocksdb.number.rate_limiter.drains COUNT : 0 rocksdb.number.iter.skip COUNT : 0 rocksdb.blobdb.num.put COUNT : 0 rocksdb.blobdb.num.write COUNT : 0 rocksdb.blobdb.num.get COUNT : 0 rocksdb.blobdb.num.multiget COUNT : 0 rocksdb.blobdb.num.seek COUNT : 0 rocksdb.blobdb.num.next COUNT : 0 rocksdb.blobdb.num.prev COUNT : 0 rocksdb.blobdb.num.keys.written COUNT : 0 rocksdb.blobdb.num.keys.read COUNT : 0 rocksdb.blobdb.bytes.written COUNT : 0 rocksdb.blobdb.bytes.read COUNT : 0 rocksdb.blobdb.write.inlined COUNT : 0 rocksdb.blobdb.write.inlined.ttl COUNT : 0 rocksdb.blobdb.write.blob COUNT : 0 rocksdb.blobdb.write.blob.ttl COUNT : 0 rocksdb.blobdb.blob.file.bytes.written COUNT : 0 rocksdb.blobdb.blob.file.bytes.read COUNT : 0 rocksdb.blobdb.blob.file.synced COUNT : 0 rocksdb.blobdb.blob.index.expired.count COUNT : 0 rocksdb.blobdb.blob.index.expired.size COUNT : 0 rocksdb.blobdb.blob.index.evicted.count COUNT : 0 rocksdb.blobdb.blob.index.evicted.size COUNT : 0 rocksdb.blobdb.gc.num.files COUNT : 0 rocksdb.blobdb.gc.num.new.files COUNT : 0 rocksdb.blobdb.gc.failures COUNT : 0 rocksdb.blobdb.gc.num.keys.relocated COUNT : 0 rocksdb.blobdb.gc.bytes.relocated COUNT : 0 rocksdb.blobdb.fifo.num.files.evicted COUNT : 0 rocksdb.blobdb.fifo.num.keys.evicted COUNT : 0 rocksdb.blobdb.fifo.bytes.evicted COUNT : 0 rocksdb.txn.overhead.mutex.prepare COUNT : 0 rocksdb.txn.overhead.mutex.old.commit.map COUNT : 0 rocksdb.txn.overhead.duplicate.key COUNT : 0 rocksdb.txn.overhead.mutex.snapshot COUNT : 0 rocksdb.txn.get.tryagain COUNT : 0 rocksdb.number.multiget.keys.found COUNT : 0 rocksdb.num.iterator.created COUNT : 0 rocksdb.num.iterator.deleted COUNT : 0 rocksdb.block.cache.compression.dict.miss COUNT : 0 rocksdb.block.cache.compression.dict.hit COUNT : 0 rocksdb.block.cache.compression.dict.add COUNT : 0 rocksdb.block.cache.compression.dict.bytes.insert COUNT : 0 rocksdb.block.cache.add.redundant COUNT : 0 rocksdb.block.cache.index.add.redundant COUNT : 0 rocksdb.block.cache.filter.add.redundant COUNT : 0 rocksdb.block.cache.data.add.redundant COUNT : 0 rocksdb.block.cache.compression.dict.add.redundant COUNT : 0 rocksdb.files.marked.trash COUNT : 0 rocksdb.files.deleted.immediately COUNT : 76 rocksdb.error.handler.bg.errro.count COUNT : 0 rocksdb.error.handler.bg.io.errro.count COUNT : 0 rocksdb.error.handler.bg.retryable.io.errro.count COUNT : 0 rocksdb.error.handler.autoresume.count COUNT : 0 rocksdb.error.handler.autoresume.retry.total.count COUNT : 0 rocksdb.error.handler.autoresume.success.count COUNT : 0 rocksdb.memtable.payload.bytes.at.flush COUNT : 4848839680 rocksdb.memtable.garbage.bytes.at.flush COUNT : 8540160 rocksdb.secondary.cache.hits COUNT : 0 rocksdb.verify_checksum.read.bytes COUNT : 0 rocksdb.backup.read.bytes COUNT : 0 rocksdb.backup.write.bytes COUNT : 0 rocksdb.remote.compact.read.bytes COUNT : 0 rocksdb.remote.compact.write.bytes COUNT : 0 rocksdb.hot.file.read.bytes COUNT : 0 rocksdb.warm.file.read.bytes COUNT : 0 rocksdb.cold.file.read.bytes COUNT : 0 rocksdb.hot.file.read.count COUNT : 0 rocksdb.warm.file.read.count COUNT : 0 rocksdb.cold.file.read.count COUNT : 0 rocksdb.last.level.read.bytes COUNT : 0 rocksdb.last.level.read.count COUNT : 0 rocksdb.non.last.level.read.bytes COUNT : 9148312168 rocksdb.non.last.level.read.count COUNT : 2209219 rocksdb.block.checksum.compute.count COUNT : 2208927 rocksdb.multiget.coroutine.count COUNT : 0 rocksdb.blobdb.cache.miss COUNT : 0 rocksdb.blobdb.cache.hit COUNT : 0 rocksdb.blobdb.cache.add COUNT : 0 rocksdb.blobdb.cache.add.failures COUNT : 0 rocksdb.blobdb.cache.bytes.read COUNT : 0 rocksdb.blobdb.cache.bytes.write COUNT : 0 rocksdb.read.async.micros COUNT : 0 rocksdb.async.read.error.count COUNT : 0 rocksdb.secondary.cache.filter.hits COUNT : 0 rocksdb.secondary.cache.index.hits COUNT : 0 rocksdb.secondary.cache.data.hits COUNT : 0 rocksdb.table.open.prefetch.tail.miss COUNT : 0 rocksdb.table.open.prefetch.tail.hit COUNT : 0 rocksdb.db.get.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.db.write.micros P50 : 1.418734 P95 : 4.922796 P99 : 8.036752 P100 : 218807.000000 COUNT : 4754999 SUM : 17917563 rocksdb.compaction.times.micros P50 : 987500.000000 P95 : 3224435.000000 P99 : 3224435.000000 P100 : 3224435.000000 COUNT : 25 SUM : 28112947 rocksdb.compaction.times.cpu_micros P50 : 987500.000000 P95 : 3081357.000000 P99 : 3081357.000000 P100 : 3081357.000000 COUNT : 25 SUM : 27267590 rocksdb.subcompaction.setup.times.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.table.sync.micros P50 : 550.000000 P95 : 1253.260870 P99 : 1421.000000 P100 : 1421.000000 COUNT : 70 SUM : 47041 rocksdb.compaction.outfile.sync.micros P50 : 705.921053 P95 : 1472.500000 P99 : 2130.000000 P100 : 2365.000000 COUNT : 77 SUM : 57737 rocksdb.wal.file.sync.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.manifest.file.sync.micros P50 : 83.212121 P95 : 305.714286 P99 : 380.000000 P100 : 414.000000 COUNT : 100 SUM : 10604 rocksdb.table.open.io.micros P50 : 797.500000 P95 : 16436.363636 P99 : 19578.000000 P100 : 19578.000000 COUNT : 153 SUM : 382106 rocksdb.db.multiget.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.read.block.compaction.micros P50 : 3.750536 P95 : 7.528241 P99 : 12.115865 P100 : 9587.000000 COUNT : 2208568 SUM : 11064933 rocksdb.read.block.get.micros P50 : 375.357143 P95 : 5140.000000 P99 : 8637.750000 P100 : 9019.000000 COUNT : 306 SUM : 273837 rocksdb.write.raw.block.micros P50 : 0.513854 P95 : 0.976322 P99 : 2.982188 P100 : 3236.000000 COUNT : 3350152 SUM : 6588002 rocksdb.numfiles.in.singlecompaction P50 : 3.352941 P95 : 9.000000 P99 : 13.500000 P100 : 15.000000 COUNT : 30 SUM : 122 rocksdb.db.seek.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.db.write.stall P50 : 0.562500 P95 : 1155.064919 P99 : 2391.961039 P100 : 218579.000000 COUNT : 39519 SUM : 6234623 rocksdb.sst.read.micros P50 : 1.624259 P95 : 4.067867 P99 : 8.429960 P100 : 8887.000000 COUNT : 2209375 SUM : 6474866 rocksdb.num.subcompactions.scheduled P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.bytes.per.read P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.bytes.per.write P50 : 1032.000000 P95 : 1032.000000 P99 : 1032.000000 P100 : 1032.000000 COUNT : 4754999 SUM : 4907158968 rocksdb.bytes.per.multiget P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.bytes.compressed P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.bytes.decompressed P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.compression.times.nanos P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.decompression.times.nanos P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.read.num.merge_operands P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.key.size P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.value.size P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.write.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.get.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.multiget.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.seek.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.next.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.prev.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.blob.file.write.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.blob.file.read.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.blob.file.sync.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.compression.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.blobdb.decompression.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.db.flush.micros P50 : 205555.555556 P95 : 298750.000000 P99 : 399704.000000 P100 : 399704.000000 COUNT : 70 SUM : 13404519 rocksdb.sst.batch.size P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.num.index.and.filter.blocks.read.per.level P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.num.sst.read.per.level P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.error.handler.autoresume.retry.count P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.async.read.bytes P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.poll.wait.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.prefetched.bytes.discarded P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 95 SUM : 0 rocksdb.multiget.io.batch.size P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.num.level.read.per.multiget P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.async.prefetch.abort.micros P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0 rocksdb.table.open.prefetch.tail.read.bytes P50 : 0.000000 P95 : 0.000000 P99 : 0.000000 P100 : 0.000000 COUNT : 0 SUM : 0