{"level":"warn","ts":"2026-04-13T01:29:24.832821Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-13T01:29:24.83293Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.70: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.70:2380","--initial-cluster=instance=https://199.204.45.70:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.70:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.70: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-04-13T01:29:24.833005Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-13T01:29:24.833024Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.70:2380"]} {"level":"info","ts":"2026-04-13T01:29:24.833048Z","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-04-13T01:29:24.834051Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"]} {"level":"info","ts":"2026-04-13T01:29:24.834139Z","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":16,"max-cpu-available":16,"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.70:2380"],"listen-peer-urls":["https://199.204.45.70:2380"],"advertise-client-urls":["https://199.204.45.70:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.70: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-04-13T01:29:24.838484Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.934534ms"} {"level":"info","ts":"2026-04-13T01:29:24.847334Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"f8844a9a4263041d","cluster-id":"4749b7c221ae0648"} {"level":"info","ts":"2026-04-13T01:29:24.847427Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=()"} {"level":"info","ts":"2026-04-13T01:29:24.847453Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became follower at term 0"} {"level":"info","ts":"2026-04-13T01:29:24.84747Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft f8844a9a4263041d [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-13T01:29:24.847482Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became follower at term 1"} {"level":"info","ts":"2026-04-13T01:29:24.84753Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=(17907520044731139101)"} {"level":"warn","ts":"2026-04-13T01:29:24.855101Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-13T01:29:24.856851Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-13T01:29:24.86005Z","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-04-13T01:29:24.862676Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"f8844a9a4263041d","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-13T01:29:24.863224Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"f8844a9a4263041d","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-13T01:29:24.863229Z","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-04-13T01:29:24.863384Z","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-04-13T01:29:24.863399Z","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-04-13T01:29:24.865963Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=(17907520044731139101)"} {"level":"info","ts":"2026-04-13T01:29:24.866099Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"4749b7c221ae0648","local-member-id":"f8844a9a4263041d","added-peer-id":"f8844a9a4263041d","added-peer-peer-urls":["https://199.204.45.70:2380"]} {"level":"info","ts":"2026-04-13T01:29:24.866825Z","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-04-13T01:29:24.867009Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.70:2380"} {"level":"info","ts":"2026-04-13T01:29:24.867055Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.70:2380"} {"level":"info","ts":"2026-04-13T01:29:24.867143Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"f8844a9a4263041d","initial-advertise-peer-urls":["https://199.204.45.70:2380"],"listen-peer-urls":["https://199.204.45.70:2380"],"advertise-client-urls":["https://199.204.45.70:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-13T01:29:24.867205Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-13T01:29:25.148697Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d is starting a new election at term 1"} {"level":"info","ts":"2026-04-13T01:29:25.148763Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became pre-candidate at term 1"} {"level":"info","ts":"2026-04-13T01:29:25.1488Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d received MsgPreVoteResp from f8844a9a4263041d at term 1"} {"level":"info","ts":"2026-04-13T01:29:25.148822Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became candidate at term 2"} {"level":"info","ts":"2026-04-13T01:29:25.148833Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d received MsgVoteResp from f8844a9a4263041d at term 2"} {"level":"info","ts":"2026-04-13T01:29:25.14885Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became leader at term 2"} {"level":"info","ts":"2026-04-13T01:29:25.148872Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: f8844a9a4263041d elected leader f8844a9a4263041d at term 2"} {"level":"info","ts":"2026-04-13T01:29:25.150608Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-13T01:29:25.152643Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"f8844a9a4263041d","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.70:2379]}","request-path":"/0/members/f8844a9a4263041d/attributes","cluster-id":"4749b7c221ae0648","publish-timeout":"7s"} {"level":"info","ts":"2026-04-13T01:29:25.152921Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-13T01:29:25.153036Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-13T01:29:25.153192Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-13T01:29:25.153505Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-13T01:29:25.154047Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"4749b7c221ae0648","local-member-id":"f8844a9a4263041d","cluster-version":"3.5"} {"level":"info","ts":"2026-04-13T01:29:25.154195Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-13T01:29:25.15425Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-13T01:29:25.157635Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.70:2379"} {"level":"info","ts":"2026-04-13T01:29:25.157926Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-13T01:29:29.800693Z","caller":"traceutil/trace.go:171","msg":"trace[1288913556] transaction","detail":"{read_only:false; response_revision:257; number_of_response:1; }","duration":"102.335347ms","start":"2026-04-13T01:29:29.698331Z","end":"2026-04-13T01:29:29.800667Z","steps":["trace[1288913556] 'process raft request' (duration: 87.531233ms)","trace[1288913556] 'compare' (duration: 14.524827ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:29:40.088065Z","caller":"traceutil/trace.go:171","msg":"trace[1611559897] transaction","detail":"{read_only:false; response_revision:408; number_of_response:1; }","duration":"190.519426ms","start":"2026-04-13T01:29:39.89752Z","end":"2026-04-13T01:29:40.08804Z","steps":["trace[1611559897] 'process raft request' (duration: 190.327261ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:29:50.540683Z","caller":"traceutil/trace.go:171","msg":"trace[1419040085] transaction","detail":"{read_only:false; response_revision:465; number_of_response:1; }","duration":"148.89997ms","start":"2026-04-13T01:29:50.391757Z","end":"2026-04-13T01:29:50.540657Z","steps":["trace[1419040085] 'process raft request' (duration: 148.717026ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:30:01.295082Z","caller":"traceutil/trace.go:171","msg":"trace[1587273798] transaction","detail":"{read_only:false; response_revision:525; number_of_response:1; }","duration":"105.087506ms","start":"2026-04-13T01:30:01.189968Z","end":"2026-04-13T01:30:01.295056Z","steps":["trace[1587273798] 'process raft request' (duration: 103.047847ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:30:07.849233Z","caller":"traceutil/trace.go:171","msg":"trace[1792238850] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"338.240115ms","start":"2026-04-13T01:30:07.510954Z","end":"2026-04-13T01:30:07.849194Z","steps":["trace[1792238850] 'process raft request' (duration: 338.002529ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:07.849843Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:07.510918Z","time spent":"338.418629ms","remote":"127.0.0.1:39492","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-13T01:30:08.539058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"479.955751ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-13T01:30:08.539307Z","caller":"traceutil/trace.go:171","msg":"trace[1658433687] transaction","detail":"{read_only:false; response_revision:633; number_of_response:1; }","duration":"639.481221ms","start":"2026-04-13T01:30:07.899762Z","end":"2026-04-13T01:30:08.539243Z","steps":["trace[1658433687] 'process raft request' (duration: 158.930366ms)","trace[1658433687] 'compare' (duration: 479.567962ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:30:08.539489Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:07.899729Z","time spent":"639.662776ms","remote":"127.0.0.1:39238","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-04-13T01:30:08.539496Z","caller":"traceutil/trace.go:171","msg":"trace[1635166981] linearizableReadLoop","detail":"{readStateIndex:658; appliedIndex:657; }","duration":"300.720014ms","start":"2026-04-13T01:30:08.238745Z","end":"2026-04-13T01:30:08.539465Z","steps":["trace[1635166981] 'read index received' (duration: 59.371µs)","trace[1635166981] 'applied index is now lower than readState.Index' (duration: 300.657683ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:30:08.539909Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"301.156564ms","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-04-13T01:30:08.540023Z","caller":"traceutil/trace.go:171","msg":"trace[1156383446] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:633; }","duration":"301.278107ms","start":"2026-04-13T01:30:08.238703Z","end":"2026-04-13T01:30:08.539981Z","steps":["trace[1156383446] 'agreement among raft nodes before linearized reading' (duration: 301.078252ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:08.540836Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:08.238672Z","time spent":"302.126727ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-04-13T01:30:08.540344Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.377075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:30:08.54035Z","caller":"traceutil/trace.go:171","msg":"trace[1567982933] transaction","detail":"{read_only:false; response_revision:634; number_of_response:1; }","duration":"252.220891ms","start":"2026-04-13T01:30:08.288102Z","end":"2026-04-13T01:30:08.540323Z","steps":["trace[1567982933] 'process raft request' (duration: 251.565015ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:30:08.540981Z","caller":"traceutil/trace.go:171","msg":"trace[1426648370] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:634; }","duration":"205.038601ms","start":"2026-04-13T01:30:08.335894Z","end":"2026-04-13T01:30:08.540933Z","steps":["trace[1426648370] 'agreement among raft nodes before linearized reading' (duration: 204.375075ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:08.540475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.443314ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.70\" ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-04-13T01:30:08.541161Z","caller":"traceutil/trace.go:171","msg":"trace[636643642] range","detail":"{range_begin:/registry/masterleases/199.204.45.70; range_end:; response_count:1; response_revision:634; }","duration":"143.14276ms","start":"2026-04-13T01:30:08.397993Z","end":"2026-04-13T01:30:08.541136Z","steps":["trace[636643642] 'agreement among raft nodes before linearized reading' (duration: 142.371042ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:09.422803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.705723ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-13T01:30:09.422948Z","caller":"traceutil/trace.go:171","msg":"trace[1971222849] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"877.24637ms","start":"2026-04-13T01:30:08.545676Z","end":"2026-04-13T01:30:09.422922Z","steps":["trace[1971222849] 'process raft request' (duration: 600.303821ms)","trace[1971222849] 'compare' (duration: 276.523869ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:30:09.423045Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:08.545649Z","time spent":"877.344452ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-13T01:30:09.428182Z","caller":"traceutil/trace.go:171","msg":"trace[1592690928] linearizableReadLoop","detail":"{readStateIndex:663; appliedIndex:660; }","duration":"534.862547ms","start":"2026-04-13T01:30:08.893304Z","end":"2026-04-13T01:30:09.428167Z","steps":["trace[1592690928] 'read index received' (duration: 252.688923ms)","trace[1592690928] 'applied index is now lower than readState.Index' (duration: 282.172604ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:30:09.428287Z","caller":"traceutil/trace.go:171","msg":"trace[1664539528] transaction","detail":"{read_only:false; response_revision:637; number_of_response:1; }","duration":"828.548983ms","start":"2026-04-13T01:30:08.599728Z","end":"2026-04-13T01:30:09.428277Z","steps":["trace[1664539528] 'process raft request' (duration: 828.39864ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:09.428355Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:08.599715Z","time spent":"828.604474ms","remote":"127.0.0.1:39208","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-13T01:30:09.428428Z","caller":"traceutil/trace.go:171","msg":"trace[139223363] transaction","detail":"{read_only:false; response_revision:636; number_of_response:1; }","duration":"833.566572ms","start":"2026-04-13T01:30:08.594829Z","end":"2026-04-13T01:30:09.428395Z","steps":["trace[139223363] 'process raft request' (duration: 833.200903ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:09.428607Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:08.594804Z","time spent":"833.697316ms","remote":"127.0.0.1:39022","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":118,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-13T01:30:09.42872Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"535.414309ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-13T01:30:09.428773Z","caller":"traceutil/trace.go:171","msg":"trace[1887792356] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:637; }","duration":"535.509332ms","start":"2026-04-13T01:30:08.893252Z","end":"2026-04-13T01:30:09.428761Z","steps":["trace[1887792356] 'agreement among raft nodes before linearized reading' (duration: 535.264116ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:30:09.428813Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:30:08.893226Z","time spent":"535.577743ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-04-13T01:30:09.428878Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.90879ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-04-13T01:30:09.42898Z","caller":"traceutil/trace.go:171","msg":"trace[434679400] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:637; }","duration":"288.055543ms","start":"2026-04-13T01:30:09.140899Z","end":"2026-04-13T01:30:09.428955Z","steps":["trace[434679400] 'agreement among raft nodes before linearized reading' (duration: 287.751546ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:30:20.143352Z","caller":"traceutil/trace.go:171","msg":"trace[361411457] transaction","detail":"{read_only:false; response_revision:767; number_of_response:1; }","duration":"108.525638ms","start":"2026-04-13T01:30:20.034797Z","end":"2026-04-13T01:30:20.143323Z","steps":["trace[361411457] 'process raft request' (duration: 96.158874ms)","trace[361411457] 'compare' (duration: 12.19579ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:30:24.279292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.439086ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-04-13T01:30:57.238527Z","caller":"traceutil/trace.go:171","msg":"trace[215592694] transaction","detail":"{read_only:false; response_revision:1211; number_of_response:1; }","duration":"206.817786ms","start":"2026-04-13T01:30:57.031691Z","end":"2026-04-13T01:30:57.238509Z","steps":["trace[215592694] 'process raft request' (duration: 206.709903ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:12.897999Z","caller":"traceutil/trace.go:171","msg":"trace[816047215] linearizableReadLoop","detail":"{readStateIndex:1388; appliedIndex:1387; }","duration":"116.960346ms","start":"2026-04-13T01:31:12.781002Z","end":"2026-04-13T01:31:12.897962Z","steps":["trace[816047215] 'read index received' (duration: 113.199816ms)","trace[816047215] 'applied index is now lower than readState.Index' (duration: 3.75914ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:31:12.898219Z","caller":"traceutil/trace.go:171","msg":"trace[1318233701] transaction","detail":"{read_only:false; response_revision:1346; number_of_response:1; }","duration":"128.250964ms","start":"2026-04-13T01:31:12.769954Z","end":"2026-04-13T01:31:12.898205Z","steps":["trace[1318233701] 'process raft request' (duration: 124.342161ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:12.898527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.492278ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" ","response":"range_response_count:1 size:559"} {"level":"info","ts":"2026-04-13T01:31:12.898635Z","caller":"traceutil/trace.go:171","msg":"trace[1192885799] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-cainjector-leader-election; range_end:; response_count:1; response_revision:1346; }","duration":"117.663422ms","start":"2026-04-13T01:31:12.780941Z","end":"2026-04-13T01:31:12.898604Z","steps":["trace[1192885799] 'agreement among raft nodes before linearized reading' (duration: 117.363645ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:20.103033Z","caller":"traceutil/trace.go:171","msg":"trace[96589073] transaction","detail":"{read_only:false; response_revision:1471; number_of_response:1; }","duration":"135.646631ms","start":"2026-04-13T01:31:19.967363Z","end":"2026-04-13T01:31:20.103009Z","steps":["trace[96589073] 'process raft request' (duration: 135.59504ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:20.103102Z","caller":"traceutil/trace.go:171","msg":"trace[498047725] transaction","detail":"{read_only:false; response_revision:1470; number_of_response:1; }","duration":"136.339027ms","start":"2026-04-13T01:31:19.966718Z","end":"2026-04-13T01:31:20.103057Z","steps":["trace[498047725] 'process raft request' (duration: 103.097805ms)","trace[498047725] 'compare' (duration: 33.014827ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:31:44.386845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.092697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-04-13T01:31:44.386927Z","caller":"traceutil/trace.go:171","msg":"trace[1041639082] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1886; }","duration":"161.23042ms","start":"2026-04-13T01:31:44.225683Z","end":"2026-04-13T01:31:44.386914Z","steps":["trace[1041639082] 'range keys from in-memory index tree' (duration: 160.922462ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:44.387303Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.954256ms","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-04-13T01:31:44.387426Z","caller":"traceutil/trace.go:171","msg":"trace[1089453107] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1886; }","duration":"222.165291ms","start":"2026-04-13T01:31:44.165237Z","end":"2026-04-13T01:31:44.387402Z","steps":["trace[1089453107] 'range keys from in-memory index tree' (duration: 221.661199ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:44.387432Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.415965ms","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-04-13T01:31:44.387518Z","caller":"traceutil/trace.go:171","msg":"trace[1061511071] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1886; }","duration":"156.517098ms","start":"2026-04-13T01:31:44.23098Z","end":"2026-04-13T01:31:44.387497Z","steps":["trace[1061511071] 'range keys from in-memory index tree' (duration: 156.18211ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:44.691562Z","caller":"traceutil/trace.go:171","msg":"trace[1040626766] transaction","detail":"{read_only:false; response_revision:1887; number_of_response:1; }","duration":"299.117304ms","start":"2026-04-13T01:31:44.392401Z","end":"2026-04-13T01:31:44.691518Z","steps":["trace[1040626766] 'process raft request' (duration: 298.873198ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:44.766413Z","caller":"traceutil/trace.go:171","msg":"trace[625420433] transaction","detail":"{read_only:false; response_revision:1888; number_of_response:1; }","duration":"373.920075ms","start":"2026-04-13T01:31:44.392461Z","end":"2026-04-13T01:31:44.766381Z","steps":["trace[625420433] 'process raft request' (duration: 373.605758ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:44.76662Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:44.392422Z","time spent":"374.082629ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-13T01:31:44.766868Z","caller":"traceutil/trace.go:171","msg":"trace[1837856312] transaction","detail":"{read_only:false; response_revision:1890; number_of_response:1; }","duration":"332.589371ms","start":"2026-04-13T01:31:44.434246Z","end":"2026-04-13T01:31:44.766836Z","steps":["trace[1837856312] 'process raft request' (duration: 332.363176ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:31:44.767083Z","caller":"traceutil/trace.go:171","msg":"trace[2001980699] transaction","detail":"{read_only:false; response_revision:1889; number_of_response:1; }","duration":"374.425588ms","start":"2026-04-13T01:31:44.392633Z","end":"2026-04-13T01:31:44.767059Z","steps":["trace[2001980699] 'process raft request' (duration: 373.652569ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:44.767112Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:44.434214Z","time spent":"332.760985ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-13T01:31:44.767179Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:44.392623Z","time spent":"374.509179ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-13T01:31:45.398173Z","caller":"traceutil/trace.go:171","msg":"trace[1112698392] linearizableReadLoop","detail":"{readStateIndex:1962; appliedIndex:1961; }","duration":"344.383961ms","start":"2026-04-13T01:31:45.053759Z","end":"2026-04-13T01:31:45.398143Z","steps":["trace[1112698392] 'read index received' (duration: 344.234287ms)","trace[1112698392] 'applied index is now lower than readState.Index' (duration: 148.074µs)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:31:45.398202Z","caller":"traceutil/trace.go:171","msg":"trace[173474324] transaction","detail":"{read_only:false; response_revision:1891; number_of_response:1; }","duration":"439.801724ms","start":"2026-04-13T01:31:44.958368Z","end":"2026-04-13T01:31:45.398169Z","steps":["trace[173474324] 'process raft request' (duration: 439.588199ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:45.398429Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:44.958329Z","time spent":"439.985168ms","remote":"127.0.0.1:39158","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3731,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-13T01:31:45.39843Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"344.668618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-13T01:31:45.398537Z","caller":"traceutil/trace.go:171","msg":"trace[586192597] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1891; }","duration":"344.823562ms","start":"2026-04-13T01:31:45.053699Z","end":"2026-04-13T01:31:45.398522Z","steps":["trace[586192597] 'agreement among raft nodes before linearized reading' (duration: 344.559936ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:45.398756Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:45.053677Z","time spent":"345.066497ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-04-13T01:31:45.400297Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.39065ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-725272d1-4b21-480b-b23b-bf595d3a4bc2\" ","response":"range_response_count:1 size:3746"} {"level":"info","ts":"2026-04-13T01:31:45.400367Z","caller":"traceutil/trace.go:171","msg":"trace[444243167] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-725272d1-4b21-480b-b23b-bf595d3a4bc2; range_end:; response_count:1; response_revision:1892; }","duration":"257.524693ms","start":"2026-04-13T01:31:45.142823Z","end":"2026-04-13T01:31:45.400348Z","steps":["trace[444243167] 'agreement among raft nodes before linearized reading' (duration: 257.369939ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:45.400296Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.027599ms","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-04-13T01:31:45.400446Z","caller":"traceutil/trace.go:171","msg":"trace[1947123496] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1892; }","duration":"330.252725ms","start":"2026-04-13T01:31:45.070174Z","end":"2026-04-13T01:31:45.400427Z","steps":["trace[1947123496] 'agreement among raft nodes before linearized reading' (duration: 329.934257ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:45.4005Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:31:45.07013Z","time spent":"330.348608ms","remote":"127.0.0.1:53122","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-04-13T01:31:51.5866Z","caller":"traceutil/trace.go:171","msg":"trace[1185497452] linearizableReadLoop","detail":"{readStateIndex:2020; appliedIndex:2019; }","duration":"145.602128ms","start":"2026-04-13T01:31:51.440957Z","end":"2026-04-13T01:31:51.586559Z","steps":["trace[1185497452] 'read index received' (duration: 80.232961ms)","trace[1185497452] 'applied index is now lower than readState.Index' (duration: 65.367157ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:31:51.586923Z","caller":"traceutil/trace.go:171","msg":"trace[1787897086] transaction","detail":"{read_only:false; response_revision:1947; number_of_response:1; }","duration":"147.419382ms","start":"2026-04-13T01:31:51.43945Z","end":"2026-04-13T01:31:51.586869Z","steps":["trace[1787897086] 'process raft request' (duration: 81.710916ms)","trace[1787897086] 'compare' (duration: 65.03791ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:31:51.587128Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.146051ms","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-04-13T01:31:51.587193Z","caller":"traceutil/trace.go:171","msg":"trace[161652211] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1947; }","duration":"146.275374ms","start":"2026-04-13T01:31:51.440902Z","end":"2026-04-13T01:31:51.587177Z","steps":["trace[161652211] 'agreement among raft nodes before linearized reading' (duration: 145.976357ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:31:51.592798Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.25503ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:31:51.592855Z","caller":"traceutil/trace.go:171","msg":"trace[1233127527] range","detail":"{range_begin:/registry/validatingwebhookconfigurations/; range_end:/registry/validatingwebhookconfigurations0; response_count:0; response_revision:1948; }","duration":"106.376414ms","start":"2026-04-13T01:31:51.486467Z","end":"2026-04-13T01:31:51.592843Z","steps":["trace[1233127527] 'agreement among raft nodes before linearized reading' (duration: 106.281071ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:32:06.407239Z","caller":"traceutil/trace.go:171","msg":"trace[1441555852] transaction","detail":"{read_only:false; response_revision:2050; number_of_response:1; }","duration":"204.124819ms","start":"2026-04-13T01:32:06.203075Z","end":"2026-04-13T01:32:06.4072Z","steps":["trace[1441555852] 'process raft request' (duration: 203.778631ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:32:40.057681Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.708969ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-13T01:32:40.057985Z","caller":"traceutil/trace.go:171","msg":"trace[1617068610] transaction","detail":"{read_only:false; response_revision:2236; number_of_response:1; }","duration":"161.06106ms","start":"2026-04-13T01:32:39.896872Z","end":"2026-04-13T01:32:40.057934Z","steps":["trace[1617068610] 'process raft request' (duration: 49.976182ms)","trace[1617068610] 'compare' (duration: 110.448463ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:32:40.057997Z","caller":"traceutil/trace.go:171","msg":"trace[2086537602] transaction","detail":"{read_only:false; response_revision:2237; number_of_response:1; }","duration":"160.706252ms","start":"2026-04-13T01:32:39.897273Z","end":"2026-04-13T01:32:40.057979Z","steps":["trace[2086537602] 'process raft request' (duration: 160.555809ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:32:41.150878Z","caller":"traceutil/trace.go:171","msg":"trace[496959107] transaction","detail":"{read_only:false; response_revision:2240; number_of_response:1; }","duration":"107.447772ms","start":"2026-04-13T01:32:41.043402Z","end":"2026-04-13T01:32:41.15085Z","steps":["trace[496959107] 'process raft request' (duration: 107.242537ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.351087Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.483432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:34:28.351205Z","caller":"traceutil/trace.go:171","msg":"trace[1089559905] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:3008; }","duration":"177.680167ms","start":"2026-04-13T01:34:28.173502Z","end":"2026-04-13T01:34:28.351182Z","steps":["trace[1089559905] 'count revisions from in-memory index tree' (duration: 177.37144ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.692792Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.647432ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:40"} {"level":"info","ts":"2026-04-13T01:34:28.692923Z","caller":"traceutil/trace.go:171","msg":"trace[1993454099] linearizableReadLoop","detail":"{readStateIndex:3123; appliedIndex:3122; }","duration":"196.50589ms","start":"2026-04-13T01:34:28.496398Z","end":"2026-04-13T01:34:28.692904Z","steps":["trace[1993454099] 'read index received' (duration: 45.591332ms)","trace[1993454099] 'applied index is now lower than readState.Index' (duration: 150.913057ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:34:28.693326Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.840731ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/auth-system/keycloak-headless\" ","response":"range_response_count:1 size:1369"} {"level":"info","ts":"2026-04-13T01:34:28.693422Z","caller":"traceutil/trace.go:171","msg":"trace[772010145] range","detail":"{range_begin:/registry/services/specs/auth-system/keycloak-headless; range_end:; response_count:1; response_revision:3009; }","duration":"140.993805ms","start":"2026-04-13T01:34:28.552408Z","end":"2026-04-13T01:34:28.693402Z","steps":["trace[772010145] 'agreement among raft nodes before linearized reading' (duration: 140.733039ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.693315Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.883098ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:34:28.693515Z","caller":"traceutil/trace.go:171","msg":"trace[1059447586] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:3009; }","duration":"197.158444ms","start":"2026-04-13T01:34:28.496334Z","end":"2026-04-13T01:34:28.693493Z","steps":["trace[1059447586] 'agreement among raft nodes before linearized reading' (duration: 196.833567ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.96893Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.655118ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-13T01:34:28.969241Z","caller":"traceutil/trace.go:171","msg":"trace[1249872852] transaction","detail":"{read_only:false; response_revision:3011; number_of_response:1; }","duration":"270.677013ms","start":"2026-04-13T01:34:28.698501Z","end":"2026-04-13T01:34:28.969178Z","steps":["trace[1249872852] 'process raft request' (duration: 270.565191ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:34:28.969249Z","caller":"traceutil/trace.go:171","msg":"trace[2144699864] transaction","detail":"{read_only:false; response_revision:3010; number_of_response:1; }","duration":"274.230337ms","start":"2026-04-13T01:34:28.694985Z","end":"2026-04-13T01:34:28.969215Z","steps":["trace[2144699864] 'process raft request' (duration: 161.165669ms)","trace[2144699864] 'compare' (duration: 112.370612ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:34:28.969315Z","caller":"traceutil/trace.go:171","msg":"trace[642425733] linearizableReadLoop","detail":"{readStateIndex:3124; appliedIndex:3123; }","duration":"270.757905ms","start":"2026-04-13T01:34:28.698446Z","end":"2026-04-13T01:34:28.969204Z","steps":["trace[642425733] 'read index received' (duration: 157.739918ms)","trace[642425733] 'applied index is now lower than readState.Index' (duration: 113.012637ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:34:28.969614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.371642ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:34:28.96966Z","caller":"traceutil/trace.go:171","msg":"trace[1375170715] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:3011; }","duration":"169.487344ms","start":"2026-04-13T01:34:28.800159Z","end":"2026-04-13T01:34:28.969647Z","steps":["trace[1375170715] 'agreement among raft nodes before linearized reading' (duration: 169.399962ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.969711Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"247.918838ms","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-04-13T01:34:28.969765Z","caller":"traceutil/trace.go:171","msg":"trace[2005978654] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:3011; }","duration":"248.025461ms","start":"2026-04-13T01:34:28.721727Z","end":"2026-04-13T01:34:28.969752Z","steps":["trace[2005978654] 'agreement among raft nodes before linearized reading' (duration: 247.810286ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:34:28.969775Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.300227ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/auth-system/keycloak-metrics\" ","response":"range_response_count:1 size:1449"} {"level":"info","ts":"2026-04-13T01:34:28.969892Z","caller":"traceutil/trace.go:171","msg":"trace[1423710765] range","detail":"{range_begin:/registry/services/specs/auth-system/keycloak-metrics; range_end:; response_count:1; response_revision:3011; }","duration":"271.447681ms","start":"2026-04-13T01:34:28.698422Z","end":"2026-04-13T01:34:28.969869Z","steps":["trace[1423710765] 'agreement among raft nodes before linearized reading' (duration: 271.046642ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:37:04.501381Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.820792ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:37:04.501524Z","caller":"traceutil/trace.go:171","msg":"trace[479394988] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4029; }","duration":"164.030106ms","start":"2026-04-13T01:37:04.33747Z","end":"2026-04-13T01:37:04.5015Z","steps":["trace[479394988] 'range keys from in-memory index tree' (duration: 163.687428ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:37:04.501619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.507947ms","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-04-13T01:37:04.501755Z","caller":"traceutil/trace.go:171","msg":"trace[703051539] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:4029; }","duration":"198.704902ms","start":"2026-04-13T01:37:04.303022Z","end":"2026-04-13T01:37:04.501727Z","steps":["trace[703051539] 'range keys from in-memory index tree' (duration: 198.356563ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:29.995543Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"350.309051ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:38:29.995695Z","caller":"traceutil/trace.go:171","msg":"trace[2052809448] range","detail":"{range_begin:/registry/validatingwebhookconfigurations/; range_end:/registry/validatingwebhookconfigurations0; response_count:0; response_revision:5208; }","duration":"350.528076ms","start":"2026-04-13T01:38:29.645129Z","end":"2026-04-13T01:38:29.995657Z","steps":["trace[2052809448] 'count revisions from in-memory index tree' (duration: 350.175837ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:29.995747Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:38:29.6451Z","time spent":"350.633128ms","remote":"127.0.0.1:39476","response type":"/etcdserverpb.KV/Range","request count":0,"request size":90,"response count":4,"response size":30,"request content":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-04-13T01:38:29.996216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.009749ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/\" range_end:\"/registry/secrets/monitoring0\" ","response":"range_response_count:24 size:719493"} {"level":"info","ts":"2026-04-13T01:38:29.996331Z","caller":"traceutil/trace.go:171","msg":"trace[1376023370] range","detail":"{range_begin:/registry/secrets/monitoring/; range_end:/registry/secrets/monitoring0; response_count:24; response_revision:5208; }","duration":"129.205354ms","start":"2026-04-13T01:38:29.8671Z","end":"2026-04-13T01:38:29.996305Z","steps":["trace[1376023370] 'range keys from in-memory index tree' (duration: 128.17699ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:32.486263Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.335557ms","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-04-13T01:38:32.486375Z","caller":"traceutil/trace.go:171","msg":"trace[1397653996] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:5253; }","duration":"157.503201ms","start":"2026-04-13T01:38:32.328852Z","end":"2026-04-13T01:38:32.486355Z","steps":["trace[1397653996] 'range keys from in-memory index tree' (duration: 157.130192ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:32.486384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.388253ms","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-04-13T01:38:32.486512Z","caller":"traceutil/trace.go:171","msg":"trace[1028656958] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:5253; }","duration":"167.577458ms","start":"2026-04-13T01:38:32.318914Z","end":"2026-04-13T01:38:32.486492Z","steps":["trace[1028656958] 'range keys from in-memory index tree' (duration: 167.159867ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:32.624821Z","caller":"traceutil/trace.go:171","msg":"trace[85986867] linearizableReadLoop","detail":"{readStateIndex:5455; appliedIndex:5453; }","duration":"126.609543ms","start":"2026-04-13T01:38:32.498183Z","end":"2026-04-13T01:38:32.624792Z","steps":["trace[85986867] 'read index received' (duration: 4.085116ms)","trace[85986867] 'applied index is now lower than readState.Index' (duration: 122.518397ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:38:32.624972Z","caller":"traceutil/trace.go:171","msg":"trace[1330756733] transaction","detail":"{read_only:false; response_revision:5256; number_of_response:1; }","duration":"131.637181ms","start":"2026-04-13T01:38:32.493309Z","end":"2026-04-13T01:38:32.624946Z","steps":["trace[1330756733] 'process raft request' (duration: 122.318772ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:32.625387Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.964717ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:38:32.625481Z","caller":"traceutil/trace.go:171","msg":"trace[449767091] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:5256; }","duration":"126.05702ms","start":"2026-04-13T01:38:32.49938Z","end":"2026-04-13T01:38:32.625437Z","steps":["trace[449767091] 'agreement among raft nodes before linearized reading' (duration: 125.944057ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:32.625511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.319669ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/\" range_end:\"/registry/secrets/monitoring0\" ","response":"range_response_count:25 size:777678"} {"level":"info","ts":"2026-04-13T01:38:32.625555Z","caller":"traceutil/trace.go:171","msg":"trace[134921662] range","detail":"{range_begin:/registry/secrets/monitoring/; range_end:/registry/secrets/monitoring0; response_count:25; response_revision:5256; }","duration":"127.427841ms","start":"2026-04-13T01:38:32.498113Z","end":"2026-04-13T01:38:32.625541Z","steps":["trace[134921662] 'agreement among raft nodes before linearized reading' (duration: 126.848348ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:42.150967Z","caller":"traceutil/trace.go:171","msg":"trace[1304404919] transaction","detail":"{read_only:false; response_revision:5445; number_of_response:1; }","duration":"107.543203ms","start":"2026-04-13T01:38:42.043389Z","end":"2026-04-13T01:38:42.150932Z","steps":["trace[1304404919] 'process raft request' (duration: 17.384879ms)","trace[1304404919] 'compare' (duration: 89.912868ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:38:42.151266Z","caller":"traceutil/trace.go:171","msg":"trace[301119955] transaction","detail":"{read_only:false; response_revision:5446; number_of_response:1; }","duration":"107.527773ms","start":"2026-04-13T01:38:42.043651Z","end":"2026-04-13T01:38:42.151179Z","steps":["trace[301119955] 'process raft request' (duration: 107.231446ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:42.845259Z","caller":"traceutil/trace.go:171","msg":"trace[1570521209] linearizableReadLoop","detail":"{readStateIndex:5657; appliedIndex:5656; }","duration":"163.208694ms","start":"2026-04-13T01:38:42.682021Z","end":"2026-04-13T01:38:42.84523Z","steps":["trace[1570521209] 'read index received' (duration: 162.965518ms)","trace[1570521209] 'applied index is now lower than readState.Index' (duration: 241.766µs)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:38:42.845274Z","caller":"traceutil/trace.go:171","msg":"trace[1720711105] transaction","detail":"{read_only:false; response_revision:5452; number_of_response:1; }","duration":"291.891795ms","start":"2026-04-13T01:38:42.553347Z","end":"2026-04-13T01:38:42.845238Z","steps":["trace[1720711105] 'process raft request' (duration: 291.66326ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:42.845504Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.463141ms","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-04-13T01:38:42.845551Z","caller":"traceutil/trace.go:171","msg":"trace[1648804769] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:5452; }","duration":"163.570374ms","start":"2026-04-13T01:38:42.681972Z","end":"2026-04-13T01:38:42.845543Z","steps":["trace[1648804769] 'agreement among raft nodes before linearized reading' (duration: 163.362369ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:42.857118Z","caller":"traceutil/trace.go:171","msg":"trace[921341911] transaction","detail":"{read_only:false; response_revision:5453; number_of_response:1; }","duration":"147.544626ms","start":"2026-04-13T01:38:42.709554Z","end":"2026-04-13T01:38:42.857098Z","steps":["trace[921341911] 'process raft request' (duration: 147.435573ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:50.549664Z","caller":"traceutil/trace.go:171","msg":"trace[469236181] linearizableReadLoop","detail":"{readStateIndex:5824; appliedIndex:5823; }","duration":"124.022642ms","start":"2026-04-13T01:38:50.425619Z","end":"2026-04-13T01:38:50.549642Z","steps":["trace[469236181] 'read index received' (duration: 123.798167ms)","trace[469236181] 'applied index is now lower than readState.Index' (duration: 223.625µs)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:38:50.549787Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.149624ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-1fc97a08-7936-47b7-98d0-8293e5bfb182\" ","response":"range_response_count:1 size:3765"} {"level":"info","ts":"2026-04-13T01:38:50.549748Z","caller":"traceutil/trace.go:171","msg":"trace[663335806] transaction","detail":"{read_only:false; response_revision:5612; number_of_response:1; }","duration":"133.704589ms","start":"2026-04-13T01:38:50.415994Z","end":"2026-04-13T01:38:50.549699Z","steps":["trace[663335806] 'process raft request' (duration: 133.510565ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:50.549818Z","caller":"traceutil/trace.go:171","msg":"trace[1225229252] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-1fc97a08-7936-47b7-98d0-8293e5bfb182; range_end:; response_count:1; response_revision:5612; }","duration":"124.227677ms","start":"2026-04-13T01:38:50.42558Z","end":"2026-04-13T01:38:50.549808Z","steps":["trace[1225229252] 'agreement among raft nodes before linearized reading' (duration: 124.150135ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:38:50.776947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.728792ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:38:50.777068Z","caller":"traceutil/trace.go:171","msg":"trace[1506444134] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:5612; }","duration":"125.933147ms","start":"2026-04-13T01:38:50.651109Z","end":"2026-04-13T01:38:50.777042Z","steps":["trace[1506444134] 'count revisions from in-memory index tree' (duration: 125.426194ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:38:51.115366Z","caller":"traceutil/trace.go:171","msg":"trace[844692248] linearizableReadLoop","detail":"{readStateIndex:5828; appliedIndex:5826; }","duration":"139.311562ms","start":"2026-04-13T01:38:50.976027Z","end":"2026-04-13T01:38:51.115339Z","steps":["trace[844692248] 'read index received' (duration: 55.074198ms)","trace[844692248] 'applied index is now lower than readState.Index' (duration: 84.235944ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:38:51.115512Z","caller":"traceutil/trace.go:171","msg":"trace[362759503] transaction","detail":"{read_only:false; response_revision:5616; number_of_response:1; }","duration":"152.479632ms","start":"2026-04-13T01:38:50.962995Z","end":"2026-04-13T01:38:51.115475Z","steps":["trace[362759503] 'process raft request' (duration: 134.829196ms)","trace[362759503] 'compare' (duration: 17.374979ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:38:51.11578Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.722541ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:38:51.116017Z","caller":"traceutil/trace.go:171","msg":"trace[612663051] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:5616; }","duration":"139.870324ms","start":"2026-04-13T01:38:50.975971Z","end":"2026-04-13T01:38:51.115841Z","steps":["trace[612663051] 'agreement among raft nodes before linearized reading' (duration: 139.472775ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:39:25.209793Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2990} {"level":"info","ts":"2026-04-13T01:39:25.282279Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2990,"took":"70.971091ms","hash":3641341739,"current-db-size-bytes":55660544,"current-db-size":"56 MB","current-db-size-in-use-bytes":32153600,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-04-13T01:39:25.282381Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3641341739,"revision":2990,"compact-revision":-1} {"level":"info","ts":"2026-04-13T01:42:10.340495Z","caller":"traceutil/trace.go:171","msg":"trace[742208586] transaction","detail":"{read_only:false; response_revision:7050; number_of_response:1; }","duration":"102.044746ms","start":"2026-04-13T01:42:10.238422Z","end":"2026-04-13T01:42:10.340467Z","steps":["trace[742208586] 'process raft request' (duration: 101.823231ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:44:25.221504Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5918} {"level":"info","ts":"2026-04-13T01:44:25.326424Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5918,"took":"102.457042ms","hash":624969476,"current-db-size-bytes":55660544,"current-db-size":"56 MB","current-db-size-in-use-bytes":26439680,"current-db-size-in-use":"26 MB"} {"level":"info","ts":"2026-04-13T01:44:25.32665Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":624969476,"revision":5918,"compact-revision":2990} {"level":"info","ts":"2026-04-13T01:45:08.024295Z","caller":"traceutil/trace.go:171","msg":"trace[1456023277] linearizableReadLoop","detail":"{readStateIndex:8802; appliedIndex:8801; }","duration":"229.033599ms","start":"2026-04-13T01:45:07.795222Z","end":"2026-04-13T01:45:08.024255Z","steps":["trace[1456023277] 'read index received' (duration: 228.701991ms)","trace[1456023277] 'applied index is now lower than readState.Index' (duration: 330.228µs)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:45:08.024427Z","caller":"traceutil/trace.go:171","msg":"trace[1753010380] transaction","detail":"{read_only:false; response_revision:8499; number_of_response:1; }","duration":"237.350704ms","start":"2026-04-13T01:45:07.787028Z","end":"2026-04-13T01:45:08.024379Z","steps":["trace[1753010380] 'process raft request' (duration: 236.986015ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:08.024594Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.345545ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/\" range_end:\"/registry/services/specs0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:45:08.024646Z","caller":"traceutil/trace.go:171","msg":"trace[1381045134] range","detail":"{range_begin:/registry/services/specs/; range_end:/registry/services/specs0; response_count:0; response_revision:8499; }","duration":"229.492298ms","start":"2026-04-13T01:45:07.795142Z","end":"2026-04-13T01:45:08.024634Z","steps":["trace[1381045134] 'agreement among raft nodes before linearized reading' (duration: 229.314554ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:08.024676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.318805ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:45:08.024768Z","caller":"traceutil/trace.go:171","msg":"trace[491702290] range","detail":"{range_begin:/registry/rolebindings/; range_end:/registry/rolebindings0; response_count:0; response_revision:8499; }","duration":"104.483658ms","start":"2026-04-13T01:45:07.920267Z","end":"2026-04-13T01:45:08.02475Z","steps":["trace[491702290] 'agreement among raft nodes before linearized reading' (duration: 104.284774ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:19.533069Z","caller":"traceutil/trace.go:171","msg":"trace[876874158] linearizableReadLoop","detail":"{readStateIndex:8865; appliedIndex:8864; }","duration":"194.8882ms","start":"2026-04-13T01:45:19.338155Z","end":"2026-04-13T01:45:19.533043Z","steps":["trace[876874158] 'read index received' (duration: 194.720396ms)","trace[876874158] 'applied index is now lower than readState.Index' (duration: 166.804µs)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:45:19.533173Z","caller":"traceutil/trace.go:171","msg":"trace[233260630] transaction","detail":"{read_only:false; response_revision:8559; number_of_response:1; }","duration":"353.293662ms","start":"2026-04-13T01:45:19.179849Z","end":"2026-04-13T01:45:19.533143Z","steps":["trace[233260630] 'process raft request' (duration: 352.998225ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:19.533252Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.076404ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:45:19.533289Z","caller":"traceutil/trace.go:171","msg":"trace[2119962699] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:8559; }","duration":"195.172096ms","start":"2026-04-13T01:45:19.338107Z","end":"2026-04-13T01:45:19.533279Z","steps":["trace[2119962699] 'agreement among raft nodes before linearized reading' (duration: 195.084294ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:19.533314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-13T01:45:19.179816Z","time spent":"353.416315ms","remote":"127.0.0.1:39238","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-13T01:45:19.533579Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.797008ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"} {"level":"warn","ts":"2026-04-13T01:45:19.53367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.803138ms","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-04-13T01:45:19.533727Z","caller":"traceutil/trace.go:171","msg":"trace[1363048528] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:8559; }","duration":"177.868089ms","start":"2026-04-13T01:45:19.355847Z","end":"2026-04-13T01:45:19.533715Z","steps":["trace[1363048528] 'agreement among raft nodes before linearized reading' (duration: 177.691425ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:19.533677Z","caller":"traceutil/trace.go:171","msg":"trace[835863246] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:8559; }","duration":"177.949712ms","start":"2026-04-13T01:45:19.355706Z","end":"2026-04-13T01:45:19.533655Z","steps":["trace[835863246] 'agreement among raft nodes before linearized reading' (duration: 177.662675ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:19.533582Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.7492ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:45:19.533895Z","caller":"traceutil/trace.go:171","msg":"trace[1949205287] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:8559; }","duration":"138.118248ms","start":"2026-04-13T01:45:19.39575Z","end":"2026-04-13T01:45:19.533868Z","steps":["trace[1949205287] 'agreement among raft nodes before linearized reading' (duration: 137.711798ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:19.533647Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.723032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"warn","ts":"2026-04-13T01:45:19.533815Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.423941ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"info","ts":"2026-04-13T01:45:19.534191Z","caller":"traceutil/trace.go:171","msg":"trace[211628066] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:8559; }","duration":"134.820991ms","start":"2026-04-13T01:45:19.399353Z","end":"2026-04-13T01:45:19.534174Z","steps":["trace[211628066] 'agreement among raft nodes before linearized reading' (duration: 134.170066ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:19.534128Z","caller":"traceutil/trace.go:171","msg":"trace[1486732718] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:8559; }","duration":"136.164442ms","start":"2026-04-13T01:45:19.397855Z","end":"2026-04-13T01:45:19.53402Z","steps":["trace[1486732718] 'agreement among raft nodes before linearized reading' (duration: 135.570989ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:20.704656Z","caller":"traceutil/trace.go:171","msg":"trace[1888420542] transaction","detail":"{read_only:false; response_revision:8566; number_of_response:1; }","duration":"123.402572ms","start":"2026-04-13T01:45:20.581216Z","end":"2026-04-13T01:45:20.704618Z","steps":["trace[1888420542] 'process raft request' (duration: 123.155497ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:21.736461Z","caller":"traceutil/trace.go:171","msg":"trace[94605642] transaction","detail":"{read_only:false; response_revision:8571; number_of_response:1; }","duration":"100.780802ms","start":"2026-04-13T01:45:21.635651Z","end":"2026-04-13T01:45:21.736432Z","steps":["trace[94605642] 'process raft request' (duration: 96.797029ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:21.758097Z","caller":"traceutil/trace.go:171","msg":"trace[637191311] transaction","detail":"{read_only:false; response_revision:8572; number_of_response:1; }","duration":"122.311817ms","start":"2026-04-13T01:45:21.635757Z","end":"2026-04-13T01:45:21.758069Z","steps":["trace[637191311] 'process raft request' (duration: 122.109663ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:21.758303Z","caller":"traceutil/trace.go:171","msg":"trace[879227286] transaction","detail":"{read_only:false; response_revision:8573; number_of_response:1; }","duration":"122.285577ms","start":"2026-04-13T01:45:21.635981Z","end":"2026-04-13T01:45:21.758267Z","steps":["trace[879227286] 'process raft request' (duration: 122.044301ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:22.316752Z","caller":"traceutil/trace.go:171","msg":"trace[49206758] linearizableReadLoop","detail":"{readStateIndex:8880; appliedIndex:8879; }","duration":"135.298161ms","start":"2026-04-13T01:45:22.181423Z","end":"2026-04-13T01:45:22.316721Z","steps":["trace[49206758] 'read index received' (duration: 135.115687ms)","trace[49206758] 'applied index is now lower than readState.Index' (duration: 180.844µs)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:45:22.316891Z","caller":"traceutil/trace.go:171","msg":"trace[883424453] transaction","detail":"{read_only:false; response_revision:8574; number_of_response:1; }","duration":"207.165606ms","start":"2026-04-13T01:45:22.109685Z","end":"2026-04-13T01:45:22.31685Z","steps":["trace[883424453] 'process raft request' (duration: 206.836998ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:22.317111Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.64897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:45:22.31719Z","caller":"traceutil/trace.go:171","msg":"trace[1415668639] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:8574; }","duration":"135.822474ms","start":"2026-04-13T01:45:22.181352Z","end":"2026-04-13T01:45:22.317174Z","steps":["trace[1415668639] 'agreement among raft nodes before linearized reading' (duration: 135.635139ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:45:49.979984Z","caller":"traceutil/trace.go:171","msg":"trace[1536013783] transaction","detail":"{read_only:false; response_revision:8777; number_of_response:1; }","duration":"207.447593ms","start":"2026-04-13T01:45:49.772499Z","end":"2026-04-13T01:45:49.979946Z","steps":["trace[1536013783] 'process raft request' (duration: 205.979458ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:45:53.292249Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.341822ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-13T01:45:53.292379Z","caller":"traceutil/trace.go:171","msg":"trace[614958556] linearizableReadLoop","detail":"{readStateIndex:9109; appliedIndex:9108; }","duration":"252.831468ms","start":"2026-04-13T01:45:53.039529Z","end":"2026-04-13T01:45:53.29236Z","steps":["trace[614958556] 'read index received' (duration: 97.2525ms)","trace[614958556] 'applied index is now lower than readState.Index' (duration: 155.577258ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:45:53.292412Z","caller":"traceutil/trace.go:171","msg":"trace[1239894516] transaction","detail":"{read_only:false; response_revision:8794; number_of_response:1; }","duration":"279.539184ms","start":"2026-04-13T01:45:53.012835Z","end":"2026-04-13T01:45:53.292374Z","steps":["trace[1239894516] 'process raft request' (duration: 123.956867ms)","trace[1239894516] 'compare' (duration: 154.925152ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:45:53.292556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.039302ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-4cbcc\" ","response":"range_response_count:1 size:6527"} {"level":"info","ts":"2026-04-13T01:45:53.292593Z","caller":"traceutil/trace.go:171","msg":"trace[118738251] range","detail":"{range_begin:/registry/pods/openstack/keepalived-4cbcc; range_end:; response_count:1; response_revision:8794; }","duration":"253.130995ms","start":"2026-04-13T01:45:53.039453Z","end":"2026-04-13T01:45:53.292584Z","steps":["trace[118738251] 'agreement among raft nodes before linearized reading' (duration: 252.958511ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:46:02.386024Z","caller":"traceutil/trace.go:171","msg":"trace[678897098] transaction","detail":"{read_only:false; response_revision:8886; number_of_response:1; }","duration":"121.12999ms","start":"2026-04-13T01:46:02.264865Z","end":"2026-04-13T01:46:02.385995Z","steps":["trace[678897098] 'process raft request' (duration: 120.947296ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:46:02.543759Z","caller":"traceutil/trace.go:171","msg":"trace[37992170] linearizableReadLoop","detail":"{readStateIndex:9206; appliedIndex:9204; }","duration":"245.780202ms","start":"2026-04-13T01:46:02.297956Z","end":"2026-04-13T01:46:02.543736Z","steps":["trace[37992170] 'read index received' (duration: 87.936102ms)","trace[37992170] 'applied index is now lower than readState.Index' (duration: 157.84299ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:46:02.543902Z","caller":"traceutil/trace.go:171","msg":"trace[1286554136] transaction","detail":"{read_only:false; response_revision:8887; number_of_response:1; }","duration":"274.215789ms","start":"2026-04-13T01:46:02.269658Z","end":"2026-04-13T01:46:02.543874Z","steps":["trace[1286554136] 'process raft request' (duration: 273.912412ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:46:02.544034Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"246.039408ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-13T01:46:02.544207Z","caller":"traceutil/trace.go:171","msg":"trace[412267692] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:8887; }","duration":"246.208832ms","start":"2026-04-13T01:46:02.297931Z","end":"2026-04-13T01:46:02.54414Z","steps":["trace[412267692] 'agreement among raft nodes before linearized reading' (duration: 246.021948ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:46:02.790634Z","caller":"traceutil/trace.go:171","msg":"trace[1209988098] linearizableReadLoop","detail":"{readStateIndex:9207; appliedIndex:9206; }","duration":"246.689493ms","start":"2026-04-13T01:46:02.543914Z","end":"2026-04-13T01:46:02.790604Z","steps":["trace[1209988098] 'read index received' (duration: 199.236451ms)","trace[1209988098] 'applied index is now lower than readState.Index' (duration: 47.451922ms)"],"step_count":2} {"level":"info","ts":"2026-04-13T01:46:02.790732Z","caller":"traceutil/trace.go:171","msg":"trace[865962032] transaction","detail":"{read_only:false; response_revision:8888; number_of_response:1; }","duration":"254.517087ms","start":"2026-04-13T01:46:02.536163Z","end":"2026-04-13T01:46:02.79068Z","steps":["trace[865962032] 'process raft request' (duration: 206.970842ms)","trace[865962032] 'compare' (duration: 47.32146ms)"],"step_count":2} {"level":"warn","ts":"2026-04-13T01:46:02.79084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.930013ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:46:02.790904Z","caller":"traceutil/trace.go:171","msg":"trace[405565475] range","detail":"{range_begin:/registry/priorityclasses/; range_end:/registry/priorityclasses0; response_count:0; response_revision:8888; }","duration":"254.066806ms","start":"2026-04-13T01:46:02.536824Z","end":"2026-04-13T01:46:02.790891Z","steps":["trace[405565475] 'agreement among raft nodes before linearized reading' (duration: 253.883402ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:46:02.790895Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.121075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-13T01:46:02.790998Z","caller":"traceutil/trace.go:171","msg":"trace[1574563554] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:8888; }","duration":"166.247218ms","start":"2026-04-13T01:46:02.62473Z","end":"2026-04-13T01:46:02.790977Z","steps":["trace[1574563554] 'agreement among raft nodes before linearized reading' (duration: 166.065604ms)"],"step_count":1} {"level":"info","ts":"2026-04-13T01:46:03.637382Z","caller":"traceutil/trace.go:171","msg":"trace[1935896391] transaction","detail":"{read_only:false; response_revision:8895; number_of_response:1; }","duration":"135.562958ms","start":"2026-04-13T01:46:03.501787Z","end":"2026-04-13T01:46:03.63735Z","steps":["trace[1935896391] 'process raft request' (duration: 135.314933ms)"],"step_count":1} {"level":"warn","ts":"2026-04-13T01:46:03.81668Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.067029ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-04-13T01:46:24.872531Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-00000000000024f0.wal"} {"level":"info","ts":"2026-04-13T01:47:23.663049Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"f8844a9a4263041d","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-04-13T01:47:23.669639Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001} {"level":"info","ts":"2026-04-13T01:47:23.669716Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001} {"level":"info","ts":"2026-04-13T01:49:25.22847Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":8096} {"level":"info","ts":"2026-04-13T01:49:25.294698Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":8096,"took":"63.869826ms","hash":751757373,"current-db-size-bytes":55660544,"current-db-size":"56 MB","current-db-size-in-use-bytes":28651520,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-04-13T01:49:25.294774Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":751757373,"revision":8096,"compact-revision":5918} {"level":"info","ts":"2026-04-13T01:54:25.235155Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":10510} {"level":"info","ts":"2026-04-13T01:54:25.321936Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":10510,"took":"83.631307ms","hash":3446218940,"current-db-size-bytes":55660544,"current-db-size":"56 MB","current-db-size-in-use-bytes":22376448,"current-db-size-in-use":"22 MB"} {"level":"info","ts":"2026-04-13T01:54:25.322025Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3446218940,"revision":10510,"compact-revision":8096}