{"level":"warn","ts":"2026-06-16T03:48:36.470027Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-16T03:48:36.470193Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.57:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.57:2380","--initial-cluster=instance=https://199.204.45.57:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.57:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.57:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-06-16T03:48:36.47032Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-16T03:48:36.470342Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.57:2380"]} {"level":"info","ts":"2026-06-16T03:48:36.470381Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-16T03:48:36.471371Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.57:2379"]} {"level":"info","ts":"2026-06-16T03:48:36.471473Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.57:2380"],"listen-peer-urls":["https://199.204.45.57:2380"],"advertise-client-urls":["https://199.204.45.57:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.57:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.57:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-06-16T03:48:36.477499Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"5.773794ms"} {"level":"info","ts":"2026-06-16T03:48:36.485817Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b6478f0ac5aeb8e1","cluster-id":"6c58cff80d4a5b62"} {"level":"info","ts":"2026-06-16T03:48:36.485956Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 switched to configuration voters=()"} {"level":"info","ts":"2026-06-16T03:48:36.485989Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 became follower at term 0"} {"level":"info","ts":"2026-06-16T03:48:36.486005Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b6478f0ac5aeb8e1 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-16T03:48:36.486022Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 became follower at term 1"} {"level":"info","ts":"2026-06-16T03:48:36.486078Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 switched to configuration voters=(13134624114678348001)"} {"level":"warn","ts":"2026-06-16T03:48:36.496842Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-16T03:48:36.498137Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-16T03:48:36.499288Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-06-16T03:48:36.501354Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b6478f0ac5aeb8e1","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-16T03:48:36.503868Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T03:48:36.503953Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T03:48:36.503967Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T03:48:36.501543Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b6478f0ac5aeb8e1","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-16T03:48:36.504454Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 switched to configuration voters=(13134624114678348001)"} {"level":"info","ts":"2026-06-16T03:48:36.50465Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"6c58cff80d4a5b62","local-member-id":"b6478f0ac5aeb8e1","added-peer-id":"b6478f0ac5aeb8e1","added-peer-peer-urls":["https://199.204.45.57:2380"]} {"level":"info","ts":"2026-06-16T03:48:36.508313Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-16T03:48:36.50841Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.57:2380"} {"level":"info","ts":"2026-06-16T03:48:36.508458Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.57:2380"} {"level":"info","ts":"2026-06-16T03:48:36.508702Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b6478f0ac5aeb8e1","initial-advertise-peer-urls":["https://199.204.45.57:2380"],"listen-peer-urls":["https://199.204.45.57:2380"],"advertise-client-urls":["https://199.204.45.57:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.57:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-16T03:48:36.50877Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-16T03:48:36.786789Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 is starting a new election at term 1"} {"level":"info","ts":"2026-06-16T03:48:36.786876Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 became pre-candidate at term 1"} {"level":"info","ts":"2026-06-16T03:48:36.786907Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 received MsgPreVoteResp from b6478f0ac5aeb8e1 at term 1"} {"level":"info","ts":"2026-06-16T03:48:36.786928Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 became candidate at term 2"} {"level":"info","ts":"2026-06-16T03:48:36.786946Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 received MsgVoteResp from b6478f0ac5aeb8e1 at term 2"} {"level":"info","ts":"2026-06-16T03:48:36.786969Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b6478f0ac5aeb8e1 became leader at term 2"} {"level":"info","ts":"2026-06-16T03:48:36.786989Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b6478f0ac5aeb8e1 elected leader b6478f0ac5aeb8e1 at term 2"} {"level":"info","ts":"2026-06-16T03:48:36.787889Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b6478f0ac5aeb8e1","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.57:2379]}","request-path":"/0/members/b6478f0ac5aeb8e1/attributes","cluster-id":"6c58cff80d4a5b62","publish-timeout":"7s"} {"level":"info","ts":"2026-06-16T03:48:36.788075Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-16T03:48:36.788146Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-16T03:48:36.788233Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-16T03:48:36.788292Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-16T03:48:36.788338Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T03:48:36.789215Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"6c58cff80d4a5b62","local-member-id":"b6478f0ac5aeb8e1","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T03:48:36.789355Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T03:48:36.789395Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T03:48:36.79189Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.57:2379"} {"level":"info","ts":"2026-06-16T03:48:36.792315Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-16T03:49:14.400576Z","caller":"traceutil/trace.go:171","msg":"trace[700466094] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"154.095216ms","start":"2026-06-16T03:49:14.246444Z","end":"2026-06-16T03:49:14.400539Z","steps":["trace[700466094] 'process raft request' (duration: 153.816109ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.407291Z","caller":"traceutil/trace.go:171","msg":"trace[234762201] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"159.332812ms","start":"2026-06-16T03:49:14.247937Z","end":"2026-06-16T03:49:14.40727Z","steps":["trace[234762201] 'process raft request' (duration: 159.080898ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.407553Z","caller":"traceutil/trace.go:171","msg":"trace[2043492232] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"149.573848ms","start":"2026-06-16T03:49:14.257754Z","end":"2026-06-16T03:49:14.407328Z","steps":["trace[2043492232] 'process raft request' (duration: 149.429165ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.407549Z","caller":"traceutil/trace.go:171","msg":"trace[1829332535] transaction","detail":"{read_only:false; response_revision:489; number_of_response:1; }","duration":"159.260464ms","start":"2026-06-16T03:49:14.248057Z","end":"2026-06-16T03:49:14.407317Z","steps":["trace[1829332535] 'process raft request' (duration: 159.090908ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.407826Z","caller":"traceutil/trace.go:171","msg":"trace[1911013972] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"149.69217ms","start":"2026-06-16T03:49:14.258058Z","end":"2026-06-16T03:49:14.40775Z","steps":["trace[1911013972] 'process raft request' (duration: 149.167169ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.407893Z","caller":"traceutil/trace.go:171","msg":"trace[204990131] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"148.116248ms","start":"2026-06-16T03:49:14.259766Z","end":"2026-06-16T03:49:14.407882Z","steps":["trace[204990131] 'process raft request' (duration: 147.501568ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.408348Z","caller":"traceutil/trace.go:171","msg":"trace[1482889592] transaction","detail":"{read_only:false; response_revision:495; number_of_response:1; }","duration":"112.003524ms","start":"2026-06-16T03:49:14.296332Z","end":"2026-06-16T03:49:14.408335Z","steps":["trace[1482889592] 'process raft request' (duration: 111.820387ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.408532Z","caller":"traceutil/trace.go:171","msg":"trace[1310694370] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"130.954188ms","start":"2026-06-16T03:49:14.277567Z","end":"2026-06-16T03:49:14.408521Z","steps":["trace[1310694370] 'process raft request' (duration: 130.256681ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:14.408586Z","caller":"traceutil/trace.go:171","msg":"trace[485544974] transaction","detail":"{read_only:false; response_revision:494; number_of_response:1; }","duration":"113.707059ms","start":"2026-06-16T03:49:14.294866Z","end":"2026-06-16T03:49:14.408573Z","steps":["trace[485544974] 'process raft request' (duration: 113.240074ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:15.041017Z","caller":"traceutil/trace.go:171","msg":"trace[1980355334] transaction","detail":"{read_only:false; response_revision:541; number_of_response:1; }","duration":"118.863864ms","start":"2026-06-16T03:49:14.922113Z","end":"2026-06-16T03:49:15.040977Z","steps":["trace[1980355334] 'process raft request' (duration: 44.76134ms)","trace[1980355334] 'compare' (duration: 73.85756ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:49:15.04685Z","caller":"traceutil/trace.go:171","msg":"trace[314750237] transaction","detail":"{read_only:false; response_revision:542; number_of_response:1; }","duration":"121.128093ms","start":"2026-06-16T03:49:14.925689Z","end":"2026-06-16T03:49:15.046817Z","steps":["trace[314750237] 'process raft request' (duration: 120.807552ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:15.047072Z","caller":"traceutil/trace.go:171","msg":"trace[41518069] transaction","detail":"{read_only:false; response_revision:543; number_of_response:1; }","duration":"107.494074ms","start":"2026-06-16T03:49:14.939556Z","end":"2026-06-16T03:49:15.04705Z","steps":["trace[41518069] 'process raft request' (duration: 107.199006ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:49:15.231797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.975902ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-06-16T03:49:15.232218Z","caller":"traceutil/trace.go:171","msg":"trace[1548969739] transaction","detail":"{read_only:false; response_revision:544; number_of_response:1; }","duration":"171.588769ms","start":"2026-06-16T03:49:15.060605Z","end":"2026-06-16T03:49:15.232194Z","steps":["trace[1548969739] 'process raft request' (duration: 171.39082ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:15.243227Z","caller":"traceutil/trace.go:171","msg":"trace[856341062] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"179.54248ms","start":"2026-06-16T03:49:15.063655Z","end":"2026-06-16T03:49:15.243198Z","steps":["trace[856341062] 'process raft request' (duration: 179.309718ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:15.243479Z","caller":"traceutil/trace.go:171","msg":"trace[2038545863] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"173.202466ms","start":"2026-06-16T03:49:15.070237Z","end":"2026-06-16T03:49:15.243439Z","steps":["trace[2038545863] 'process raft request' (duration: 172.914809ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:15.417409Z","caller":"traceutil/trace.go:171","msg":"trace[1815453226] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"117.239286ms","start":"2026-06-16T03:49:15.300133Z","end":"2026-06-16T03:49:15.417372Z","steps":["trace[1815453226] 'process raft request' (duration: 64.600247ms)","trace[1815453226] 'compare' (duration: 52.355652ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:49:15.430449Z","caller":"traceutil/trace.go:171","msg":"trace[218862076] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"125.938078ms","start":"2026-06-16T03:49:15.304494Z","end":"2026-06-16T03:49:15.430432Z","steps":["trace[218862076] 'process raft request' (duration: 125.483604ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:20.643663Z","caller":"traceutil/trace.go:171","msg":"trace[636319451] transaction","detail":"{read_only:false; response_revision:592; number_of_response:1; }","duration":"100.022793ms","start":"2026-06-16T03:49:20.543612Z","end":"2026-06-16T03:49:20.643635Z","steps":["trace[636319451] 'process raft request' (duration: 99.063659ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:20.798507Z","caller":"traceutil/trace.go:171","msg":"trace[1818728288] transaction","detail":"{read_only:false; response_revision:593; number_of_response:1; }","duration":"134.207741ms","start":"2026-06-16T03:49:20.664263Z","end":"2026-06-16T03:49:20.798471Z","steps":["trace[1818728288] 'process raft request' (duration: 133.987537ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:20.812177Z","caller":"traceutil/trace.go:171","msg":"trace[387144206] transaction","detail":"{read_only:false; response_revision:594; number_of_response:1; }","duration":"113.456651ms","start":"2026-06-16T03:49:20.698685Z","end":"2026-06-16T03:49:20.812142Z","steps":["trace[387144206] 'process raft request' (duration: 113.295603ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:49:21.636991Z","caller":"traceutil/trace.go:171","msg":"trace[552159802] linearizableReadLoop","detail":"{readStateIndex:620; appliedIndex:619; }","duration":"208.039429ms","start":"2026-06-16T03:49:21.428919Z","end":"2026-06-16T03:49:21.636958Z","steps":["trace[552159802] 'read index received' (duration: 207.005219ms)","trace[552159802] 'applied index is now lower than readState.Index' (duration: 1.032961ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:49:21.637048Z","caller":"traceutil/trace.go:171","msg":"trace[396106963] transaction","detail":"{read_only:false; response_revision:598; number_of_response:1; }","duration":"390.642203ms","start":"2026-06-16T03:49:21.24637Z","end":"2026-06-16T03:49:21.637013Z","steps":["trace[396106963] 'process raft request' (duration: 389.828608ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:49:21.637225Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.221956ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:49:21.637276Z","caller":"traceutil/trace.go:171","msg":"trace[472431446] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:598; }","duration":"208.408024ms","start":"2026-06-16T03:49:21.428851Z","end":"2026-06-16T03:49:21.637259Z","steps":["trace[472431446] 'agreement among raft nodes before linearized reading' (duration: 208.238606ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:49:21.63768Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:49:21.246337Z","time spent":"390.783073ms","remote":"127.0.0.1:51318","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T03:49:21.876966Z","caller":"traceutil/trace.go:171","msg":"trace[1885206395] transaction","detail":"{read_only:false; response_revision:599; number_of_response:1; }","duration":"181.45657ms","start":"2026-06-16T03:49:21.695468Z","end":"2026-06-16T03:49:21.876925Z","steps":["trace[1885206395] 'process raft request' (duration: 179.319823ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:49:37.463613Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.983611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-16T03:49:37.463699Z","caller":"traceutil/trace.go:171","msg":"trace[1223548859] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:756; }","duration":"212.114867ms","start":"2026-06-16T03:49:37.251566Z","end":"2026-06-16T03:49:37.463681Z","steps":["trace[1223548859] 'range keys from in-memory index tree' (duration: 211.811128ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.187153Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.984793ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-683660b7-cfcb-4367-ba92-6019141e2da5\" ","response":"range_response_count:1 size:3626"} {"level":"info","ts":"2026-06-16T03:51:19.187256Z","caller":"traceutil/trace.go:171","msg":"trace[338761712] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-683660b7-cfcb-4367-ba92-6019141e2da5; range_end:; response_count:1; response_revision:1922; }","duration":"142.197224ms","start":"2026-06-16T03:51:19.045042Z","end":"2026-06-16T03:51:19.187239Z","steps":["trace[338761712] 'range keys from in-memory index tree' (duration: 141.76917ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:19.187181Z","caller":"traceutil/trace.go:171","msg":"trace[1334554145] transaction","detail":"{read_only:false; response_revision:1923; number_of_response:1; }","duration":"115.164406ms","start":"2026-06-16T03:51:19.071989Z","end":"2026-06-16T03:51:19.187154Z","steps":["trace[1334554145] 'process raft request' (duration: 71.701508ms)","trace[1334554145] 'compare' (duration: 43.359412ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:51:19.254498Z","caller":"traceutil/trace.go:171","msg":"trace[1599272227] transaction","detail":"{read_only:false; response_revision:1924; number_of_response:1; }","duration":"100.771095ms","start":"2026-06-16T03:51:19.153698Z","end":"2026-06-16T03:51:19.254469Z","steps":["trace[1599272227] 'process raft request' (duration: 100.595985ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.673764Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.514138ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T03:51:19.673873Z","caller":"traceutil/trace.go:171","msg":"trace[205257375] transaction","detail":"{read_only:false; response_revision:1928; number_of_response:1; }","duration":"238.365515ms","start":"2026-06-16T03:51:19.435493Z","end":"2026-06-16T03:51:19.673859Z","steps":["trace[205257375] 'process raft request' (duration: 36.671446ms)","trace[205257375] 'compare' (duration: 201.18397ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:51:19.762714Z","caller":"traceutil/trace.go:171","msg":"trace[786169476] linearizableReadLoop","detail":"{readStateIndex:2007; appliedIndex:2004; }","duration":"230.788698ms","start":"2026-06-16T03:51:19.531901Z","end":"2026-06-16T03:51:19.76269Z","steps":["trace[786169476] 'read index received' (duration: 230.550705ms)","trace[786169476] 'applied index is now lower than readState.Index' (duration: 237.083µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:51:19.762836Z","caller":"traceutil/trace.go:171","msg":"trace[2107376853] transaction","detail":"{read_only:false; response_revision:1929; number_of_response:1; }","duration":"327.299507ms","start":"2026-06-16T03:51:19.435524Z","end":"2026-06-16T03:51:19.762824Z","steps":["trace[2107376853] 'process raft request' (duration: 326.971368ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:19.762985Z","caller":"traceutil/trace.go:171","msg":"trace[1993418622] transaction","detail":"{read_only:false; response_revision:1931; number_of_response:1; }","duration":"327.269976ms","start":"2026-06-16T03:51:19.435685Z","end":"2026-06-16T03:51:19.762955Z","steps":["trace[1993418622] 'process raft request' (duration: 326.957358ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.76317Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:19.435679Z","time spent":"327.395312ms","remote":"127.0.0.1:51488","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1472,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T03:51:19.763384Z","caller":"traceutil/trace.go:171","msg":"trace[2112207127] transaction","detail":"{read_only:false; response_revision:1930; number_of_response:1; }","duration":"327.763874ms","start":"2026-06-16T03:51:19.435609Z","end":"2026-06-16T03:51:19.763373Z","steps":["trace[2112207127] 'process raft request' (duration: 326.99829ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.763522Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:19.43559Z","time spent":"327.895481ms","remote":"127.0.0.1:51390","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":894,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:51:19.763537Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.617606ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-16T03:51:19.763618Z","caller":"traceutil/trace.go:171","msg":"trace[824152119] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1931; }","duration":"231.745144ms","start":"2026-06-16T03:51:19.531854Z","end":"2026-06-16T03:51:19.763599Z","steps":["trace[824152119] 'agreement among raft nodes before linearized reading' (duration: 231.491019ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.763845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.451878ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-06-16T03:51:19.763943Z","caller":"traceutil/trace.go:171","msg":"trace[1992627676] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1931; }","duration":"230.622108ms","start":"2026-06-16T03:51:19.5333Z","end":"2026-06-16T03:51:19.763922Z","steps":["trace[1992627676] 'agreement among raft nodes before linearized reading' (duration: 229.923148ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:19.763933Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:19.435508Z","time spent":"327.367421ms","remote":"127.0.0.1:51390","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":978,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:51:36.65403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.664076ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:51:36.654104Z","caller":"traceutil/trace.go:171","msg":"trace[599560627] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2066; }","duration":"226.773844ms","start":"2026-06-16T03:51:36.427313Z","end":"2026-06-16T03:51:36.654087Z","steps":["trace[599560627] 'range keys from in-memory index tree' (duration: 226.584331ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:36.65403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.185695ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:51:36.654178Z","caller":"traceutil/trace.go:171","msg":"trace[714322084] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:2066; }","duration":"123.348965ms","start":"2026-06-16T03:51:36.53081Z","end":"2026-06-16T03:51:36.654159Z","steps":["trace[714322084] 'range keys from in-memory index tree' (duration: 123.168304ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:52.476871Z","caller":"traceutil/trace.go:171","msg":"trace[190075476] transaction","detail":"{read_only:false; response_revision:2165; number_of_response:1; }","duration":"103.904806ms","start":"2026-06-16T03:51:52.372931Z","end":"2026-06-16T03:51:52.476836Z","steps":["trace[190075476] 'process raft request' (duration: 103.738924ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.139037Z","caller":"traceutil/trace.go:171","msg":"trace[1798591251] transaction","detail":"{read_only:false; response_revision:2192; number_of_response:1; }","duration":"119.732535ms","start":"2026-06-16T03:51:58.019274Z","end":"2026-06-16T03:51:58.139006Z","steps":["trace[1798591251] 'process raft request' (duration: 119.564833ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.158251Z","caller":"traceutil/trace.go:171","msg":"trace[1857027088] linearizableReadLoop","detail":"{readStateIndex:2279; appliedIndex:2278; }","duration":"133.029743ms","start":"2026-06-16T03:51:58.025196Z","end":"2026-06-16T03:51:58.158226Z","steps":["trace[1857027088] 'read index received' (duration: 113.838582ms)","trace[1857027088] 'applied index is now lower than readState.Index' (duration: 19.190321ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T03:51:58.158382Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.163132ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:51:58.158312Z","caller":"traceutil/trace.go:171","msg":"trace[1404746522] transaction","detail":"{read_only:false; response_revision:2193; number_of_response:1; }","duration":"138.712671ms","start":"2026-06-16T03:51:58.019582Z","end":"2026-06-16T03:51:58.158294Z","steps":["trace[1404746522] 'process raft request' (duration: 138.549239ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.158462Z","caller":"traceutil/trace.go:171","msg":"trace[2137905999] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:2193; }","duration":"133.282ms","start":"2026-06-16T03:51:58.025146Z","end":"2026-06-16T03:51:58.158428Z","steps":["trace[2137905999] 'agreement among raft nodes before linearized reading' (duration: 133.175252ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.352469Z","caller":"traceutil/trace.go:171","msg":"trace[590464402] transaction","detail":"{read_only:false; response_revision:2194; number_of_response:1; }","duration":"132.648338ms","start":"2026-06-16T03:51:58.2198Z","end":"2026-06-16T03:51:58.352449Z","steps":["trace[590464402] 'process raft request' (duration: 132.505807ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.360325Z","caller":"traceutil/trace.go:171","msg":"trace[713922359] transaction","detail":"{read_only:false; response_revision:2195; number_of_response:1; }","duration":"140.141639ms","start":"2026-06-16T03:51:58.22016Z","end":"2026-06-16T03:51:58.360302Z","steps":["trace[713922359] 'process raft request' (duration: 139.973837ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:58.657078Z","caller":"traceutil/trace.go:171","msg":"trace[1796644622] transaction","detail":"{read_only:false; response_revision:2197; number_of_response:1; }","duration":"163.366804ms","start":"2026-06-16T03:51:58.493685Z","end":"2026-06-16T03:51:58.657052Z","steps":["trace[1796644622] 'process raft request' (duration: 163.209963ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:59.601677Z","caller":"traceutil/trace.go:171","msg":"trace[2028746861] linearizableReadLoop","detail":"{readStateIndex:2284; appliedIndex:2283; }","duration":"435.425204ms","start":"2026-06-16T03:51:59.166216Z","end":"2026-06-16T03:51:59.601641Z","steps":["trace[2028746861] 'read index received' (duration: 435.277034ms)","trace[2028746861] 'applied index is now lower than readState.Index' (duration: 146.84µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:51:59.601765Z","caller":"traceutil/trace.go:171","msg":"trace[1636753760] transaction","detail":"{read_only:false; response_revision:2198; number_of_response:1; }","duration":"552.358311ms","start":"2026-06-16T03:51:59.049368Z","end":"2026-06-16T03:51:59.601727Z","steps":["trace[1636753760] 'process raft request' (duration: 552.110704ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:59.60194Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:59.049342Z","time spent":"552.501121ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:51:59.602027Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"435.797691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5412"} {"level":"info","ts":"2026-06-16T03:51:59.602149Z","caller":"traceutil/trace.go:171","msg":"trace[735792267] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2198; }","duration":"435.990264ms","start":"2026-06-16T03:51:59.166141Z","end":"2026-06-16T03:51:59.602131Z","steps":["trace[735792267] 'agreement among raft nodes before linearized reading' (duration: 435.634989ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:59.602197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:59.16611Z","time spent":"436.0759ms","remote":"127.0.0.1:45798","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5435,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "} {"level":"info","ts":"2026-06-16T03:51:59.626741Z","caller":"traceutil/trace.go:171","msg":"trace[37231005] transaction","detail":"{read_only:false; response_revision:2199; number_of_response:1; }","duration":"175.603813ms","start":"2026-06-16T03:51:59.451118Z","end":"2026-06-16T03:51:59.626722Z","steps":["trace[37231005] 'process raft request' (duration: 175.383658ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:51:59.626966Z","caller":"traceutil/trace.go:171","msg":"trace[1348739978] transaction","detail":"{read_only:false; response_revision:2200; number_of_response:1; }","duration":"169.659387ms","start":"2026-06-16T03:51:59.457293Z","end":"2026-06-16T03:51:59.626952Z","steps":["trace[1348739978] 'process raft request' (duration: 169.386308ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:59.6271Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.686523ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:51:59.627186Z","caller":"traceutil/trace.go:171","msg":"trace[986109972] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2200; }","duration":"199.821953ms","start":"2026-06-16T03:51:59.427344Z","end":"2026-06-16T03:51:59.627166Z","steps":["trace[986109972] 'agreement among raft nodes before linearized reading' (duration: 199.64362ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:59.627289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"328.559438ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T03:51:59.627404Z","caller":"traceutil/trace.go:171","msg":"trace[305414202] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:2200; }","duration":"328.757322ms","start":"2026-06-16T03:51:59.298622Z","end":"2026-06-16T03:51:59.627379Z","steps":["trace[305414202] 'agreement among raft nodes before linearized reading' (duration: 328.521236ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:51:59.627464Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:51:59.298597Z","time spent":"328.854038ms","remote":"127.0.0.1:51622","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":30,"request content":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true "} {"level":"info","ts":"2026-06-16T03:53:34.043242Z","caller":"traceutil/trace.go:171","msg":"trace[420923699] transaction","detail":"{read_only:false; response_revision:2811; number_of_response:1; }","duration":"115.559323ms","start":"2026-06-16T03:53:33.927656Z","end":"2026-06-16T03:53:34.043216Z","steps":["trace[420923699] 'process raft request' (duration: 115.41087ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:53:34.078102Z","caller":"traceutil/trace.go:171","msg":"trace[1645678214] transaction","detail":"{read_only:false; response_revision:2812; number_of_response:1; }","duration":"147.193981ms","start":"2026-06-16T03:53:33.930883Z","end":"2026-06-16T03:53:34.078077Z","steps":["trace[1645678214] 'process raft request' (duration: 147.012259ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:53:34.078252Z","caller":"traceutil/trace.go:171","msg":"trace[1899578283] transaction","detail":"{read_only:false; response_revision:2813; number_of_response:1; }","duration":"144.577386ms","start":"2026-06-16T03:53:33.933631Z","end":"2026-06-16T03:53:34.078208Z","steps":["trace[1899578283] 'process raft request' (duration: 144.400435ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:03.434059Z","caller":"traceutil/trace.go:171","msg":"trace[478318709] transaction","detail":"{read_only:false; response_revision:4415; number_of_response:1; }","duration":"111.841121ms","start":"2026-06-16T03:57:03.322195Z","end":"2026-06-16T03:57:03.434036Z","steps":["trace[478318709] 'process raft request' (duration: 111.770178ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:03.434127Z","caller":"traceutil/trace.go:171","msg":"trace[1878624676] transaction","detail":"{read_only:false; response_revision:4414; number_of_response:1; }","duration":"133.156993ms","start":"2026-06-16T03:57:03.300935Z","end":"2026-06-16T03:57:03.434092Z","steps":["trace[1878624676] 'process raft request' (duration: 51.235028ms)","trace[1878624676] 'compare' (duration: 81.305228ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T03:57:03.988591Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.866602ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-16T03:57:03.988788Z","caller":"traceutil/trace.go:171","msg":"trace[328712308] transaction","detail":"{read_only:false; response_revision:4424; number_of_response:1; }","duration":"278.745167ms","start":"2026-06-16T03:57:03.710015Z","end":"2026-06-16T03:57:03.988761Z","steps":["trace[328712308] 'process raft request' (duration: 93.645404ms)","trace[328712308] 'compare' (duration: 184.714656ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:03.988852Z","caller":"traceutil/trace.go:171","msg":"trace[1406326304] linearizableReadLoop","detail":"{readStateIndex:4601; appliedIndex:4599; }","duration":"251.498512ms","start":"2026-06-16T03:57:03.737331Z","end":"2026-06-16T03:57:03.98883Z","steps":["trace[1406326304] 'read index received' (duration: 66.326496ms)","trace[1406326304] 'applied index is now lower than readState.Index' (duration: 185.169916ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:03.988928Z","caller":"traceutil/trace.go:171","msg":"trace[1282054221] transaction","detail":"{read_only:false; response_revision:4426; number_of_response:1; }","duration":"246.845935ms","start":"2026-06-16T03:57:03.742075Z","end":"2026-06-16T03:57:03.988921Z","steps":["trace[1282054221] 'process raft request' (duration: 246.688068ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:03.988937Z","caller":"traceutil/trace.go:171","msg":"trace[2005530180] transaction","detail":"{read_only:false; response_revision:4425; number_of_response:1; }","duration":"266.586779ms","start":"2026-06-16T03:57:03.722338Z","end":"2026-06-16T03:57:03.988925Z","steps":["trace[2005530180] 'process raft request' (duration: 266.353049ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:03.989085Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.428646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-06-16T03:57:03.988872Z","caller":"traceutil/trace.go:171","msg":"trace[1467732070] transaction","detail":"{read_only:false; response_revision:4427; number_of_response:1; }","duration":"224.197833ms","start":"2026-06-16T03:57:03.764662Z","end":"2026-06-16T03:57:03.98886Z","steps":["trace[1467732070] 'process raft request' (duration: 224.152801ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:03.989113Z","caller":"traceutil/trace.go:171","msg":"trace[370090927] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4427; }","duration":"300.49839ms","start":"2026-06-16T03:57:03.688607Z","end":"2026-06-16T03:57:03.989105Z","steps":["trace[370090927] 'agreement among raft nodes before linearized reading' (duration: 300.380995ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:03.989138Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:03.688592Z","time spent":"300.541272ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-16T03:57:04.004724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.602566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-tls\" ","response":"range_response_count:1 size:4316"} {"level":"warn","ts":"2026-06-16T03:57:04.004866Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.726232ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-16T03:57:04.004919Z","caller":"traceutil/trace.go:171","msg":"trace[909351373] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4428; }","duration":"176.827187ms","start":"2026-06-16T03:57:03.828078Z","end":"2026-06-16T03:57:04.004905Z","steps":["trace[909351373] 'agreement among raft nodes before linearized reading' (duration: 176.625818ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:04.004961Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.653139ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-tls-2dzpj\" ","response":"range_response_count:1 size:2460"} {"level":"warn","ts":"2026-06-16T03:57:04.004737Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.234814ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-06-16T03:57:04.005003Z","caller":"traceutil/trace.go:171","msg":"trace[267623405] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-tls-2dzpj; range_end:; response_count:1; response_revision:4428; }","duration":"183.738772ms","start":"2026-06-16T03:57:03.821253Z","end":"2026-06-16T03:57:04.004992Z","steps":["trace[267623405] 'agreement among raft nodes before linearized reading' (duration: 183.622307ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:04.005018Z","caller":"traceutil/trace.go:171","msg":"trace[1057130812] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4428; }","duration":"172.549408ms","start":"2026-06-16T03:57:03.832452Z","end":"2026-06-16T03:57:04.005001Z","steps":["trace[1057130812] 'agreement among raft nodes before linearized reading' (duration: 172.191412ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:04.004968Z","caller":"traceutil/trace.go:171","msg":"trace[1839436992] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-tls; range_end:; response_count:1; response_revision:4428; }","duration":"230.786324ms","start":"2026-06-16T03:57:03.774101Z","end":"2026-06-16T03:57:04.004887Z","steps":["trace[1839436992] 'agreement among raft nodes before linearized reading' (duration: 230.499671ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:04.004789Z","caller":"traceutil/trace.go:171","msg":"trace[1596800390] transaction","detail":"{read_only:false; response_revision:4428; number_of_response:1; }","duration":"122.638048ms","start":"2026-06-16T03:57:03.882124Z","end":"2026-06-16T03:57:04.004762Z","steps":["trace[1596800390] 'process raft request' (duration: 122.340665ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:09.061198Z","caller":"traceutil/trace.go:171","msg":"trace[1173607484] transaction","detail":"{read_only:false; response_revision:4564; number_of_response:1; }","duration":"132.969518ms","start":"2026-06-16T03:57:08.928205Z","end":"2026-06-16T03:57:09.061175Z","steps":["trace[1173607484] 'process raft request' (duration: 132.78915ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:13.167693Z","caller":"traceutil/trace.go:171","msg":"trace[35201625] transaction","detail":"{read_only:false; response_revision:4674; number_of_response:1; }","duration":"274.862096ms","start":"2026-06-16T03:57:12.892807Z","end":"2026-06-16T03:57:13.167669Z","steps":["trace[35201625] 'process raft request' (duration: 274.766582ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:13.167707Z","caller":"traceutil/trace.go:171","msg":"trace[1736852839] transaction","detail":"{read_only:false; response_revision:4673; number_of_response:1; }","duration":"306.059984ms","start":"2026-06-16T03:57:12.861616Z","end":"2026-06-16T03:57:13.167676Z","steps":["trace[1736852839] 'process raft request' (duration: 305.450215ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:13.168149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:12.8616Z","time spent":"306.18901ms","remote":"127.0.0.1:51294","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":947,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T03:57:13.169216Z","caller":"traceutil/trace.go:171","msg":"trace[335223270] transaction","detail":"{read_only:false; response_revision:4675; number_of_response:1; }","duration":"255.384234ms","start":"2026-06-16T03:57:12.913809Z","end":"2026-06-16T03:57:13.169193Z","steps":["trace[335223270] 'process raft request' (duration: 255.211887ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:18.185937Z","caller":"traceutil/trace.go:171","msg":"trace[1436762947] transaction","detail":"{read_only:false; response_revision:4715; number_of_response:1; }","duration":"115.973496ms","start":"2026-06-16T03:57:18.069936Z","end":"2026-06-16T03:57:18.18591Z","steps":["trace[1436762947] 'process raft request' (duration: 80.675617ms)","trace[1436762947] 'compare' (duration: 35.009186ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:18.186086Z","caller":"traceutil/trace.go:171","msg":"trace[1814259048] linearizableReadLoop","detail":"{readStateIndex:4899; appliedIndex:4898; }","duration":"110.146504ms","start":"2026-06-16T03:57:18.07592Z","end":"2026-06-16T03:57:18.186067Z","steps":["trace[1814259048] 'read index received' (duration: 74.697499ms)","trace[1814259048] 'applied index is now lower than readState.Index' (duration: 35.447865ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T03:57:18.18634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.414076ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-keystone\" ","response":"range_response_count:1 size:1652"} {"level":"info","ts":"2026-06-16T03:57:18.186368Z","caller":"traceutil/trace.go:171","msg":"trace[1724594926] range","detail":"{range_begin:/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-keystone; range_end:; response_count:1; response_revision:4716; }","duration":"110.449038ms","start":"2026-06-16T03:57:18.075909Z","end":"2026-06-16T03:57:18.186358Z","steps":["trace[1724594926] 'agreement among raft nodes before linearized reading' (duration: 110.312892ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:18.658236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.840386ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-16T03:57:18.658499Z","caller":"traceutil/trace.go:171","msg":"trace[242512153] linearizableReadLoop","detail":"{readStateIndex:4909; appliedIndex:4907; }","duration":"280.472991ms","start":"2026-06-16T03:57:18.377928Z","end":"2026-06-16T03:57:18.658401Z","steps":["trace[242512153] 'read index received' (duration: 5.272816ms)","trace[242512153] 'applied index is now lower than readState.Index' (duration: 275.199125ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:18.658711Z","caller":"traceutil/trace.go:171","msg":"trace[1480904048] transaction","detail":"{read_only:false; response_revision:4726; number_of_response:1; }","duration":"280.267541ms","start":"2026-06-16T03:57:18.37843Z","end":"2026-06-16T03:57:18.658697Z","steps":["trace[1480904048] 'process raft request' (duration: 279.901934ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:18.65895Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.005686ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ranges/serviceips\" ","response":"range_response_count:1 size:123239"} {"level":"info","ts":"2026-06-16T03:57:18.659001Z","caller":"traceutil/trace.go:171","msg":"trace[1447425537] range","detail":"{range_begin:/registry/ranges/serviceips; range_end:; response_count:1; response_revision:4726; }","duration":"281.10967ms","start":"2026-06-16T03:57:18.377882Z","end":"2026-06-16T03:57:18.658991Z","steps":["trace[1447425537] 'agreement among raft nodes before linearized reading' (duration: 280.869699ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:18.658682Z","caller":"traceutil/trace.go:171","msg":"trace[2056841508] transaction","detail":"{read_only:false; response_revision:4725; number_of_response:1; }","duration":"281.054378ms","start":"2026-06-16T03:57:18.377582Z","end":"2026-06-16T03:57:18.658637Z","steps":["trace[2056841508] 'process raft request' (duration: 44.730789ms)","trace[2056841508] 'compare' (duration: 235.684478ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:18.880157Z","caller":"traceutil/trace.go:171","msg":"trace[314571012] linearizableReadLoop","detail":"{readStateIndex:4911; appliedIndex:4910; }","duration":"221.59187ms","start":"2026-06-16T03:57:18.658538Z","end":"2026-06-16T03:57:18.88013Z","steps":["trace[314571012] 'read index received' (duration: 144.218486ms)","trace[314571012] 'applied index is now lower than readState.Index' (duration: 77.372294ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T03:57:18.880376Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"452.535407ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:57:18.88042Z","caller":"traceutil/trace.go:171","msg":"trace[1318660059] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4727; }","duration":"452.658993ms","start":"2026-06-16T03:57:18.427749Z","end":"2026-06-16T03:57:18.880408Z","steps":["trace[1318660059] 'agreement among raft nodes before linearized reading' (duration: 452.475285ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:18.880486Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:18.427727Z","time spent":"452.749318ms","remote":"127.0.0.1:51202","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-16T03:57:18.880769Z","caller":"traceutil/trace.go:171","msg":"trace[152344290] transaction","detail":"{read_only:false; response_revision:4727; number_of_response:1; }","duration":"299.666197ms","start":"2026-06-16T03:57:18.581086Z","end":"2026-06-16T03:57:18.880752Z","steps":["trace[152344290] 'process raft request' (duration: 221.648983ms)","trace[152344290] 'compare' (duration: 77.294971ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:18.894021Z","caller":"traceutil/trace.go:171","msg":"trace[1644815226] transaction","detail":"{read_only:false; response_revision:4728; number_of_response:1; }","duration":"232.434947ms","start":"2026-06-16T03:57:18.661573Z","end":"2026-06-16T03:57:18.894008Z","steps":["trace[1644815226] 'process raft request' (duration: 232.171594ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:19.519586Z","caller":"traceutil/trace.go:171","msg":"trace[834152703] transaction","detail":"{read_only:false; response_revision:4747; number_of_response:1; }","duration":"449.037972ms","start":"2026-06-16T03:57:19.070531Z","end":"2026-06-16T03:57:19.519569Z","steps":["trace[834152703] 'process raft request' (duration: 448.902646ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:19.51969Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:19.070519Z","time spent":"449.123146ms","remote":"127.0.0.1:51440","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":698,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-16T03:57:19.537272Z","caller":"traceutil/trace.go:171","msg":"trace[1978838812] linearizableReadLoop","detail":"{readStateIndex:4932; appliedIndex:4930; }","duration":"463.977752ms","start":"2026-06-16T03:57:19.073275Z","end":"2026-06-16T03:57:19.537253Z","steps":["trace[1978838812] 'read index received' (duration: 446.224371ms)","trace[1978838812] 'applied index is now lower than readState.Index' (duration: 17.752331ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:19.537251Z","caller":"traceutil/trace.go:171","msg":"trace[1799162685] transaction","detail":"{read_only:false; response_revision:4748; number_of_response:1; }","duration":"465.673952ms","start":"2026-06-16T03:57:19.071554Z","end":"2026-06-16T03:57:19.537228Z","steps":["trace[1799162685] 'process raft request' (duration: 465.474543ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:19.537311Z","caller":"traceutil/trace.go:171","msg":"trace[1151681833] transaction","detail":"{read_only:false; response_revision:4749; number_of_response:1; }","duration":"350.545917ms","start":"2026-06-16T03:57:19.186733Z","end":"2026-06-16T03:57:19.537278Z","steps":["trace[1151681833] 'process raft request' (duration: 350.39444ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:19.537376Z","caller":"traceutil/trace.go:171","msg":"trace[775362988] transaction","detail":"{read_only:false; response_revision:4750; number_of_response:1; }","duration":"350.436722ms","start":"2026-06-16T03:57:19.186928Z","end":"2026-06-16T03:57:19.537365Z","steps":["trace[775362988] 'process raft request' (duration: 350.287525ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:19.537458Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:19.186913Z","time spent":"350.489314ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:57:19.537482Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:19.186708Z","time spent":"350.673853ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:57:19.537463Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:19.071534Z","time spent":"465.810058ms","remote":"127.0.0.1:51294","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":739,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-16T03:57:19.537636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"464.36222ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-0\" ","response":"range_response_count:1 size:650"} {"level":"info","ts":"2026-06-16T03:57:19.53767Z","caller":"traceutil/trace.go:171","msg":"trace[1237477600] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-0; range_end:; response_count:1; response_revision:4750; }","duration":"464.408092ms","start":"2026-06-16T03:57:19.073252Z","end":"2026-06-16T03:57:19.53766Z","steps":["trace[1237477600] 'agreement among raft nodes before linearized reading' (duration: 464.295677ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:19.537705Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:19.073241Z","time spent":"464.457254ms","remote":"127.0.0.1:51318","response type":"/etcdserverpb.KV/Range","request count":0,"request size":91,"response count":1,"response size":673,"request content":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-0\" "} {"level":"warn","ts":"2026-06-16T03:57:19.538022Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.632584ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-06-16T03:57:19.538085Z","caller":"traceutil/trace.go:171","msg":"trace[2013159621] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4750; }","duration":"193.724909ms","start":"2026-06-16T03:57:19.344351Z","end":"2026-06-16T03:57:19.538076Z","steps":["trace[2013159621] 'agreement among raft nodes before linearized reading' (duration: 193.609124ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:19.538325Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"216.659433ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T03:57:19.538381Z","caller":"traceutil/trace.go:171","msg":"trace[975202916] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:4750; }","duration":"216.740537ms","start":"2026-06-16T03:57:19.321626Z","end":"2026-06-16T03:57:19.538366Z","steps":["trace[975202916] 'agreement among raft nodes before linearized reading' (duration: 216.5948ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:19.539924Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"299.288955ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/monitoring/\" range_end:\"/registry/configmaps/monitoring0\" ","response":"range_response_count:47 size:2209712"} {"level":"info","ts":"2026-06-16T03:57:19.539985Z","caller":"traceutil/trace.go:171","msg":"trace[91347207] range","detail":"{range_begin:/registry/configmaps/monitoring/; range_end:/registry/configmaps/monitoring0; response_count:47; response_revision:4750; }","duration":"299.38558ms","start":"2026-06-16T03:57:19.240587Z","end":"2026-06-16T03:57:19.539972Z","steps":["trace[91347207] 'agreement among raft nodes before linearized reading' (duration: 297.039679ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:57:23.434091Z","caller":"traceutil/trace.go:171","msg":"trace[372695388] linearizableReadLoop","detail":"{readStateIndex:5003; appliedIndex:5002; }","duration":"359.384787ms","start":"2026-06-16T03:57:23.07468Z","end":"2026-06-16T03:57:23.434064Z","steps":["trace[372695388] 'read index received' (duration: 359.184607ms)","trace[372695388] 'applied index is now lower than readState.Index' (duration: 196.469µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T03:57:23.434213Z","caller":"traceutil/trace.go:171","msg":"trace[1879241232] transaction","detail":"{read_only:false; response_revision:4818; number_of_response:1; }","duration":"437.861431ms","start":"2026-06-16T03:57:22.996341Z","end":"2026-06-16T03:57:23.434202Z","steps":["trace[1879241232] 'process raft request' (duration: 437.554907ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:23.434313Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:22.996315Z","time spent":"437.927895ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T03:57:23.434434Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.740114ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-keystone\" ","response":"range_response_count:1 size:3316"} {"level":"info","ts":"2026-06-16T03:57:23.434511Z","caller":"traceutil/trace.go:171","msg":"trace[1390402506] range","detail":"{range_begin:/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-keystone; range_end:; response_count:1; response_revision:4818; }","duration":"359.86129ms","start":"2026-06-16T03:57:23.074633Z","end":"2026-06-16T03:57:23.434494Z","steps":["trace[1390402506] 'agreement among raft nodes before linearized reading' (duration: 359.65996ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T03:57:23.43457Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T03:57:23.074615Z","time spent":"359.946843ms","remote":"127.0.0.1:43968","response type":"/etcdserverpb.KV/Range","request count":0,"request size":69,"response count":1,"response size":3339,"request content":"key:\"/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-keystone\" "} {"level":"warn","ts":"2026-06-16T03:57:32.596313Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.546336ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T03:57:32.596428Z","caller":"traceutil/trace.go:171","msg":"trace[103140648] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4959; }","duration":"168.695314ms","start":"2026-06-16T03:57:32.427705Z","end":"2026-06-16T03:57:32.5964Z","steps":["trace[103140648] 'range keys from in-memory index tree' (duration: 168.42059ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:58:37.021707Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2831} {"level":"info","ts":"2026-06-16T03:58:37.099408Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2831,"took":"76.230542ms","hash":903971793,"current-db-size-bytes":52678656,"current-db-size":"53 MB","current-db-size-in-use-bytes":29048832,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-06-16T03:58:37.099479Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":903971793,"revision":2831,"compact-revision":-1} {"level":"info","ts":"2026-06-16T03:59:45.200589Z","caller":"traceutil/trace.go:171","msg":"trace[275421326] linearizableReadLoop","detail":"{readStateIndex:6128; appliedIndex:6127; }","duration":"117.842005ms","start":"2026-06-16T03:59:45.082722Z","end":"2026-06-16T03:59:45.200564Z","steps":["trace[275421326] 'read index received' (duration: 96.14033ms)","trace[275421326] 'applied index is now lower than readState.Index' (duration: 21.700765ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T03:59:45.20081Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.072689ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-06-16T03:59:45.200863Z","caller":"traceutil/trace.go:171","msg":"trace[881037381] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:5910; }","duration":"118.171895ms","start":"2026-06-16T03:59:45.082665Z","end":"2026-06-16T03:59:45.200837Z","steps":["trace[881037381] 'agreement among raft nodes before linearized reading' (duration: 118.017436ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T03:59:45.200835Z","caller":"traceutil/trace.go:171","msg":"trace[1040064257] transaction","detail":"{read_only:false; response_revision:5910; number_of_response:1; }","duration":"132.320096ms","start":"2026-06-16T03:59:45.068469Z","end":"2026-06-16T03:59:45.200789Z","steps":["trace[1040064257] 'process raft request' (duration: 110.385286ms)","trace[1040064257] 'compare' (duration: 21.590219ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T04:01:12.532983Z","caller":"traceutil/trace.go:171","msg":"trace[1789869148] linearizableReadLoop","detail":"{readStateIndex:6795; appliedIndex:6792; }","duration":"104.310031ms","start":"2026-06-16T04:01:12.428653Z","end":"2026-06-16T04:01:12.532963Z","steps":["trace[1789869148] 'read index received' (duration: 17.09595ms)","trace[1789869148] 'applied index is now lower than readState.Index' (duration: 87.213431ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T04:01:12.533091Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.423918ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T04:01:12.533112Z","caller":"traceutil/trace.go:171","msg":"trace[1843269505] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6553; }","duration":"104.522564ms","start":"2026-06-16T04:01:12.428583Z","end":"2026-06-16T04:01:12.533106Z","steps":["trace[1843269505] 'agreement among raft nodes before linearized reading' (duration: 104.45511ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:01:12.533263Z","caller":"traceutil/trace.go:171","msg":"trace[965043754] transaction","detail":"{read_only:false; response_revision:6553; number_of_response:1; }","duration":"140.129826ms","start":"2026-06-16T04:01:12.393114Z","end":"2026-06-16T04:01:12.533244Z","steps":["trace[965043754] 'process raft request' (duration: 139.816445ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:01:12.533381Z","caller":"traceutil/trace.go:171","msg":"trace[1548732020] transaction","detail":"{read_only:false; response_revision:6552; number_of_response:1; }","duration":"143.303727ms","start":"2026-06-16T04:01:12.390058Z","end":"2026-06-16T04:01:12.533362Z","steps":["trace[1548732020] 'process raft request' (duration: 142.746981ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:05.679903Z","caller":"traceutil/trace.go:171","msg":"trace[654845324] linearizableReadLoop","detail":"{readStateIndex:7138; appliedIndex:7137; }","duration":"160.553603ms","start":"2026-06-16T04:02:05.519322Z","end":"2026-06-16T04:02:05.679875Z","steps":["trace[654845324] 'read index received' (duration: 160.414087ms)","trace[654845324] 'applied index is now lower than readState.Index' (duration: 138.396µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T04:02:05.680327Z","caller":"traceutil/trace.go:171","msg":"trace[185287008] transaction","detail":"{read_only:false; response_revision:6883; number_of_response:1; }","duration":"280.574044ms","start":"2026-06-16T04:02:05.399712Z","end":"2026-06-16T04:02:05.680286Z","steps":["trace[185287008] 'process raft request' (duration: 279.902373ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:05.680993Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.65186ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/horizon-7c794c8bfd-4qjjq\" ","response":"range_response_count:1 size:9696"} {"level":"info","ts":"2026-06-16T04:02:05.681048Z","caller":"traceutil/trace.go:171","msg":"trace[1479999053] range","detail":"{range_begin:/registry/pods/openstack/horizon-7c794c8bfd-4qjjq; range_end:; response_count:1; response_revision:6883; }","duration":"161.755457ms","start":"2026-06-16T04:02:05.519279Z","end":"2026-06-16T04:02:05.681034Z","steps":["trace[1479999053] 'agreement among raft nodes before linearized reading' (duration: 160.722327ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:06.126447Z","caller":"traceutil/trace.go:171","msg":"trace[175141822] linearizableReadLoop","detail":"{readStateIndex:7139; appliedIndex:7138; }","duration":"402.338872ms","start":"2026-06-16T04:02:05.724089Z","end":"2026-06-16T04:02:06.126428Z","steps":["trace[175141822] 'read index received' (duration: 402.208475ms)","trace[175141822] 'applied index is now lower than readState.Index' (duration: 129.647µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T04:02:06.126569Z","caller":"traceutil/trace.go:171","msg":"trace[1017190754] transaction","detail":"{read_only:false; response_revision:6884; number_of_response:1; }","duration":"434.702282ms","start":"2026-06-16T04:02:05.691826Z","end":"2026-06-16T04:02:06.126529Z","steps":["trace[1017190754] 'process raft request' (duration: 434.46684ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.12665Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"402.544055ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-06-16T04:02:06.126679Z","caller":"traceutil/trace.go:171","msg":"trace[1393605548] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:6884; }","duration":"402.614783ms","start":"2026-06-16T04:02:05.724055Z","end":"2026-06-16T04:02:06.12667Z","steps":["trace[1393605548] 'agreement among raft nodes before linearized reading' (duration: 402.494897ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.126703Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:05.72404Z","time spent":"402.656062ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-06-16T04:02:06.126709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"401.05971ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-16T04:02:06.126765Z","caller":"traceutil/trace.go:171","msg":"trace[2127846079] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:6884; }","duration":"401.143688ms","start":"2026-06-16T04:02:05.725607Z","end":"2026-06-16T04:02:06.126751Z","steps":["trace[2127846079] 'agreement among raft nodes before linearized reading' (duration: 401.031181ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.126762Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:05.691809Z","time spent":"434.853247ms","remote":"127.0.0.1:51416","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9503,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T04:02:06.126793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:05.725594Z","time spent":"401.190206ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-06-16T04:02:06.126881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.008788ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-06-16T04:02:06.126896Z","caller":"traceutil/trace.go:171","msg":"trace[1036430178] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:6884; }","duration":"135.045196ms","start":"2026-06-16T04:02:05.991847Z","end":"2026-06-16T04:02:06.126892Z","steps":["trace[1036430178] 'agreement among raft nodes before linearized reading' (duration: 135.002488ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.126956Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"255.634159ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T04:02:06.126969Z","caller":"traceutil/trace.go:171","msg":"trace[473415740] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:6884; }","duration":"255.695477ms","start":"2026-06-16T04:02:05.871269Z","end":"2026-06-16T04:02:06.126964Z","steps":["trace[473415740] 'agreement among raft nodes before linearized reading' (duration: 255.657578ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.126973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.17281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-06-16T04:02:06.126998Z","caller":"traceutil/trace.go:171","msg":"trace[1593723994] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:6884; }","duration":"150.224168ms","start":"2026-06-16T04:02:05.976767Z","end":"2026-06-16T04:02:06.126991Z","steps":["trace[1593723994] 'agreement among raft nodes before linearized reading' (duration: 150.141451ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.510626Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.508473ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T04:02:06.510797Z","caller":"traceutil/trace.go:171","msg":"trace[498433697] transaction","detail":"{read_only:false; response_revision:6885; number_of_response:1; }","duration":"379.524996ms","start":"2026-06-16T04:02:06.131195Z","end":"2026-06-16T04:02:06.51072Z","steps":["trace[498433697] 'process raft request' (duration: 167.841758ms)","trace[498433697] 'compare' (duration: 211.382478ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T04:02:06.510993Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.131182Z","time spent":"379.694571ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.762969Z","caller":"traceutil/trace.go:171","msg":"trace[149344334] transaction","detail":"{read_only:false; response_revision:6886; number_of_response:1; }","duration":"631.024843ms","start":"2026-06-16T04:02:06.131923Z","end":"2026-06-16T04:02:06.762948Z","steps":["trace[149344334] 'process raft request' (duration: 589.708698ms)","trace[149344334] 'compare' (duration: 41.072522ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T04:02:06.763071Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.131909Z","time spent":"631.10486ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.763119Z","caller":"traceutil/trace.go:171","msg":"trace[983495103] transaction","detail":"{read_only:false; response_revision:6887; number_of_response:1; }","duration":"630.427851ms","start":"2026-06-16T04:02:06.132659Z","end":"2026-06-16T04:02:06.763086Z","steps":["trace[983495103] 'process raft request' (duration: 630.195358ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.763298Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.132652Z","time spent":"630.555177ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.763477Z","caller":"traceutil/trace.go:171","msg":"trace[1259927085] transaction","detail":"{read_only:false; response_revision:6888; number_of_response:1; }","duration":"630.77745ms","start":"2026-06-16T04:02:06.132666Z","end":"2026-06-16T04:02:06.763443Z","steps":["trace[1259927085] 'process raft request' (duration: 630.500588ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:06.763519Z","caller":"traceutil/trace.go:171","msg":"trace[2003666660] transaction","detail":"{read_only:false; response_revision:6889; number_of_response:1; }","duration":"630.753521ms","start":"2026-06-16T04:02:06.132738Z","end":"2026-06-16T04:02:06.763491Z","steps":["trace[2003666660] 'process raft request' (duration: 630.645775ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.763652Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.132657Z","time spent":"630.897857ms","remote":"127.0.0.1:51538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1092,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T04:02:06.763743Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.132732Z","time spent":"630.925625ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.763792Z","caller":"traceutil/trace.go:171","msg":"trace[1709833734] transaction","detail":"{read_only:false; response_revision:6891; number_of_response:1; }","duration":"630.217118ms","start":"2026-06-16T04:02:06.133568Z","end":"2026-06-16T04:02:06.763785Z","steps":["trace[1709833734] 'process raft request' (duration: 629.970665ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.763832Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.133559Z","time spent":"630.253716ms","remote":"127.0.0.1:51488","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1480,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.763669Z","caller":"traceutil/trace.go:171","msg":"trace[898081293] transaction","detail":"{read_only:false; response_revision:6890; number_of_response:1; }","duration":"630.862877ms","start":"2026-06-16T04:02:06.132798Z","end":"2026-06-16T04:02:06.763661Z","steps":["trace[898081293] 'process raft request' (duration: 630.632154ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.763903Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.132792Z","time spent":"631.079111ms","remote":"127.0.0.1:51390","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":876,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:06.763982Z","caller":"traceutil/trace.go:171","msg":"trace[1412331006] transaction","detail":"{read_only:false; response_revision:6892; number_of_response:1; }","duration":"629.142899ms","start":"2026-06-16T04:02:06.134822Z","end":"2026-06-16T04:02:06.763965Z","steps":["trace[1412331006] 'process raft request' (duration: 628.872297ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:06.764072Z","caller":"traceutil/trace.go:171","msg":"trace[579101551] linearizableReadLoop","detail":"{readStateIndex:7146; appliedIndex:7139; }","duration":"629.536487ms","start":"2026-06-16T04:02:06.134527Z","end":"2026-06-16T04:02:06.764064Z","steps":["trace[579101551] 'read index received' (duration: 164.597206ms)","trace[579101551] 'applied index is now lower than readState.Index' (duration: 464.938641ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T04:02:06.764135Z","caller":"traceutil/trace.go:171","msg":"trace[307510481] transaction","detail":"{read_only:false; response_revision:6893; number_of_response:1; }","duration":"106.310219ms","start":"2026-06-16T04:02:06.657821Z","end":"2026-06-16T04:02:06.764131Z","steps":["trace[307510481] 'process raft request' (duration: 106.009988ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.764116Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.134815Z","time spent":"629.253745ms","remote":"127.0.0.1:51726","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8615,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T04:02:06.764242Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"629.720691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/horizon-7c794c8bfd-bd6dq\" ","response":"range_response_count:1 size:9699"} {"level":"info","ts":"2026-06-16T04:02:06.764261Z","caller":"traceutil/trace.go:171","msg":"trace[1679708756] range","detail":"{range_begin:/registry/pods/openstack/horizon-7c794c8bfd-bd6dq; range_end:; response_count:1; response_revision:6893; }","duration":"629.75985ms","start":"2026-06-16T04:02:06.134497Z","end":"2026-06-16T04:02:06.764257Z","steps":["trace[1679708756] 'agreement among raft nodes before linearized reading' (duration: 629.601775ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.764274Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.134488Z","time spent":"629.783451ms","remote":"127.0.0.1:51416","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":1,"response size":9722,"request content":"key:\"/registry/pods/openstack/horizon-7c794c8bfd-bd6dq\" "} {"level":"warn","ts":"2026-06-16T04:02:06.771521Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"343.057557ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T04:02:06.771648Z","caller":"traceutil/trace.go:171","msg":"trace[425032295] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6895; }","duration":"343.257541ms","start":"2026-06-16T04:02:06.428374Z","end":"2026-06-16T04:02:06.771632Z","steps":["trace[425032295] 'agreement among raft nodes before linearized reading' (duration: 343.080286ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:06.771685Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:06.428352Z","time spent":"343.325329ms","remote":"127.0.0.1:51202","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-16T04:02:06.772422Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.652299ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T04:02:06.772505Z","caller":"traceutil/trace.go:171","msg":"trace[1110461389] range","detail":"{range_begin:/registry/daemonsets/; range_end:/registry/daemonsets0; response_count:0; response_revision:6895; }","duration":"104.770666ms","start":"2026-06-16T04:02:06.667722Z","end":"2026-06-16T04:02:06.772493Z","steps":["trace[1110461389] 'agreement among raft nodes before linearized reading' (duration: 104.656549ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:10.00742Z","caller":"traceutil/trace.go:171","msg":"trace[721602421] transaction","detail":"{read_only:false; response_revision:6921; number_of_response:1; }","duration":"316.234698ms","start":"2026-06-16T04:02:09.691153Z","end":"2026-06-16T04:02:10.007387Z","steps":["trace[721602421] 'process raft request' (duration: 316.051633ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:10.007625Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T04:02:09.691123Z","time spent":"316.405563ms","remote":"127.0.0.1:51476","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T04:02:14.788253Z","caller":"traceutil/trace.go:171","msg":"trace[556433892] linearizableReadLoop","detail":"{readStateIndex:7200; appliedIndex:7199; }","duration":"212.99568ms","start":"2026-06-16T04:02:14.575234Z","end":"2026-06-16T04:02:14.788229Z","steps":["trace[556433892] 'read index received' (duration: 212.854304ms)","trace[556433892] 'applied index is now lower than readState.Index' (duration: 140.676µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T04:02:14.788336Z","caller":"traceutil/trace.go:171","msg":"trace[1849323521] transaction","detail":"{read_only:false; response_revision:6944; number_of_response:1; }","duration":"243.557176ms","start":"2026-06-16T04:02:14.544756Z","end":"2026-06-16T04:02:14.788313Z","steps":["trace[1849323521] 'process raft request' (duration: 243.347022ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:14.78848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"213.224814ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T04:02:14.788522Z","caller":"traceutil/trace.go:171","msg":"trace[219512876] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:6944; }","duration":"213.311461ms","start":"2026-06-16T04:02:14.575201Z","end":"2026-06-16T04:02:14.788513Z","steps":["trace[219512876] 'agreement among raft nodes before linearized reading' (duration: 213.181235ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.004421Z","caller":"traceutil/trace.go:171","msg":"trace[1747253420] transaction","detail":"{read_only:false; response_revision:6945; number_of_response:1; }","duration":"212.945341ms","start":"2026-06-16T04:02:14.791431Z","end":"2026-06-16T04:02:15.004377Z","steps":["trace[1747253420] 'process raft request' (duration: 210.991024ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.033361Z","caller":"traceutil/trace.go:171","msg":"trace[1771669221] transaction","detail":"{read_only:false; response_revision:6946; number_of_response:1; }","duration":"240.489749ms","start":"2026-06-16T04:02:14.792817Z","end":"2026-06-16T04:02:15.033307Z","steps":["trace[1771669221] 'process raft request' (duration: 240.288155ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.033611Z","caller":"traceutil/trace.go:171","msg":"trace[173751100] transaction","detail":"{read_only:false; response_revision:6947; number_of_response:1; }","duration":"237.474163ms","start":"2026-06-16T04:02:14.796079Z","end":"2026-06-16T04:02:15.033553Z","steps":["trace[173751100] 'process raft request' (duration: 237.185929ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:15.033929Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"236.389843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-16T04:02:15.034396Z","caller":"traceutil/trace.go:171","msg":"trace[16232761] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:6947; }","duration":"236.86655ms","start":"2026-06-16T04:02:14.797493Z","end":"2026-06-16T04:02:15.034359Z","steps":["trace[16232761] 'agreement among raft nodes before linearized reading' (duration: 236.140429ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.033512Z","caller":"traceutil/trace.go:171","msg":"trace[1264708581] linearizableReadLoop","detail":"{readStateIndex:7203; appliedIndex:7200; }","duration":"235.971343ms","start":"2026-06-16T04:02:14.797514Z","end":"2026-06-16T04:02:15.033485Z","steps":["trace[1264708581] 'read index received' (duration: 205.032907ms)","trace[1264708581] 'applied index is now lower than readState.Index' (duration: 30.936656ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T04:02:15.034954Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.191259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-06-16T04:02:15.035049Z","caller":"traceutil/trace.go:171","msg":"trace[1077310322] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:6947; }","duration":"233.328226ms","start":"2026-06-16T04:02:14.801706Z","end":"2026-06-16T04:02:15.035034Z","steps":["trace[1077310322] 'agreement among raft nodes before linearized reading' (duration: 233.114772ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T04:02:15.035307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.935365ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-06-16T04:02:15.03555Z","caller":"traceutil/trace.go:171","msg":"trace[1414905080] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:6947; }","duration":"236.190967ms","start":"2026-06-16T04:02:14.799345Z","end":"2026-06-16T04:02:15.035535Z","steps":["trace[1414905080] 'agreement among raft nodes before linearized reading' (duration: 235.414599ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.277332Z","caller":"traceutil/trace.go:171","msg":"trace[1053185936] transaction","detail":"{read_only:false; response_revision:6948; number_of_response:1; }","duration":"238.405755ms","start":"2026-06-16T04:02:15.0389Z","end":"2026-06-16T04:02:15.277305Z","steps":["trace[1053185936] 'process raft request' (duration: 238.231379ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.279256Z","caller":"traceutil/trace.go:171","msg":"trace[966572136] transaction","detail":"{read_only:false; response_revision:6949; number_of_response:1; }","duration":"237.544107ms","start":"2026-06-16T04:02:15.041685Z","end":"2026-06-16T04:02:15.279229Z","steps":["trace[966572136] 'process raft request' (duration: 237.306024ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.27931Z","caller":"traceutil/trace.go:171","msg":"trace[189015398] transaction","detail":"{read_only:false; response_revision:6950; number_of_response:1; }","duration":"237.501599ms","start":"2026-06-16T04:02:15.041779Z","end":"2026-06-16T04:02:15.279281Z","steps":["trace[189015398] 'process raft request' (duration: 237.308674ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:02:15.282652Z","caller":"traceutil/trace.go:171","msg":"trace[711242150] linearizableReadLoop","detail":"{readStateIndex:7206; appliedIndex:7203; }","duration":"232.575691ms","start":"2026-06-16T04:02:15.050063Z","end":"2026-06-16T04:02:15.282639Z","steps":["trace[711242150] 'read index received' (duration: 227.077069ms)","trace[711242150] 'applied index is now lower than readState.Index' (duration: 5.497302ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T04:02:15.282839Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.742456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-16T04:02:15.282871Z","caller":"traceutil/trace.go:171","msg":"trace[382954344] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:6950; }","duration":"232.839385ms","start":"2026-06-16T04:02:15.050022Z","end":"2026-06-16T04:02:15.282862Z","steps":["trace[382954344] 'agreement among raft nodes before linearized reading' (duration: 232.666869ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T04:03:37.031036Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5514} {"level":"info","ts":"2026-06-16T04:03:37.123438Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5514,"took":"90.558221ms","hash":4243595878,"current-db-size-bytes":52678656,"current-db-size":"53 MB","current-db-size-in-use-bytes":18292736,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-06-16T04:03:37.123509Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4243595878,"revision":5514,"compact-revision":2831}