Project

General

Profile

Actions

Bug #61953

closed

bluestore: bluestore slow latency report when rocksdb compaction

Added by yite gu 10 months ago. Updated 9 months ago.

Status:
Won't Fix
Priority:
Normal
Assignee:
-
Target version:
-
% Done:

0%

Source:
Tags:
Backport:
Regression:
No
Severity:
3 - minor
Reviewed:
Affected Versions:
ceph-qa-suite:
Pull request ID:
Crash signature (v1):
Crash signature (v2):

Description

2023-07-11T06:30:19.492+0000 7f692d8c4700  4 rocksdb: [compaction/compaction_job.cc:1676] [P] [JOB 37] Compacting 2@0 + 1@1 files to L1, score 1.19
2023-07-11T06:30:19.492+0000 7f692d8c4700  4 rocksdb: [compaction/compaction_job.cc:1680] [P] Compaction start summary: Base version 95 Base level 0, inputs: [25842(30MB) 25824(30MB)], [25822(52MB)]

2023-07-11T06:30:19.492+0000 7f692d8c4700  4 rocksdb: EVENT_LOG_v1 {"time_micros": 1689057019492695, "job": 37, "event": "compaction_started", "compaction_reason": "LevelL0FilesNum", "files_L0": [25842, 25824], "files_L1": [25822], "score": 1.18745, "input_data_size": 119089362}
2023-07-11T06:30:19.492+0000 7f692d0c3700  4 rocksdb: [db_impl/db_impl_files.cc:353] [JOB 36] Try to delete WAL files size 275931261, prev total WAL file size 744269564, number of live WAL files 4.

2023-07-11T06:30:19.967+0000 7f6919035700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency slow operation observed for submit_transact, latency = 0.033606321s
2023-07-11T06:30:19.967+0000 7f691502d700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency slow operation observed for submit_transact, latency = 0.031010913s
2023-07-11T06:30:19.967+0000 7f692beb2700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency_fn slow operation observed for _txc_committed_kv, latency = 0.034002703s, txc = 0x56193fab0700
2023-07-11T06:30:19.967+0000 7f691382a700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency slow operation observed for submit_transact, latency = 0.036432911s
2023-07-11T06:30:19.968+0000 7f692beb2700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency_fn slow operation observed for _txc_committed_kv, latency = 0.032162540s, txc = 0x5618f1cee380
2023-07-11T06:30:19.968+0000 7f692beb2700  0 bluestore(/var/lib/ceph/osd/ceph-6) log_latency_fn slow operation observed for _txc_committed_kv, latency = 0.037519719s, txc = 0x5617328bca80
2023-07-11T06:30:20.138+0000 7f692d8c4700  4 rocksdb: [compaction/compaction_job.cc:1349] [P] [JOB 37] Generated table #25843: 278981 keys, 55386292 bytes
Actions

Also available in: Atom PDF