{"level":"warn","ts":"2026-05-19T13:35:32.903398Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-19T13:35:32.90356Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.222: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.222:2380","--initial-cluster=instance=https://199.204.45.222:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.222:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.222: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-05-19T13:35:32.903714Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-19T13:35:32.903741Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.222:2380"]} {"level":"info","ts":"2026-05-19T13:35:32.903775Z","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-05-19T13:35:32.905007Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"]} {"level":"info","ts":"2026-05-19T13:35:32.905139Z","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.222:2380"],"listen-peer-urls":["https://199.204.45.222:2380"],"advertise-client-urls":["https://199.204.45.222:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.222: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-05-19T13:35:32.911727Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.217667ms"} {"level":"info","ts":"2026-05-19T13:35:32.926388Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"380f6760faea5f9e","cluster-id":"b87e8aca83a17eab"} {"level":"info","ts":"2026-05-19T13:35:32.926521Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=()"} {"level":"info","ts":"2026-05-19T13:35:32.926555Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became follower at term 0"} {"level":"info","ts":"2026-05-19T13:35:32.926568Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 380f6760faea5f9e [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-19T13:35:32.926587Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became follower at term 1"} {"level":"info","ts":"2026-05-19T13:35:32.926641Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=(4039561056998809502)"} {"level":"warn","ts":"2026-05-19T13:35:32.937542Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-19T13:35:32.939021Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-19T13:35:32.940411Z","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-05-19T13:35:32.943478Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"380f6760faea5f9e","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-19T13:35:32.943735Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"380f6760faea5f9e","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-19T13:35:32.943988Z","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-05-19T13:35:32.944083Z","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-05-19T13:35:32.9441Z","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-05-19T13:35:32.944968Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=(4039561056998809502)"} {"level":"info","ts":"2026-05-19T13:35:32.945187Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"b87e8aca83a17eab","local-member-id":"380f6760faea5f9e","added-peer-id":"380f6760faea5f9e","added-peer-peer-urls":["https://199.204.45.222:2380"]} {"level":"info","ts":"2026-05-19T13:35:32.950866Z","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-05-19T13:35:32.951474Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"380f6760faea5f9e","initial-advertise-peer-urls":["https://199.204.45.222:2380"],"listen-peer-urls":["https://199.204.45.222:2380"],"advertise-client-urls":["https://199.204.45.222:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-19T13:35:32.951558Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-19T13:35:32.951754Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.222:2380"} {"level":"info","ts":"2026-05-19T13:35:32.951816Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.222:2380"} {"level":"info","ts":"2026-05-19T13:35:33.127839Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e is starting a new election at term 1"} {"level":"info","ts":"2026-05-19T13:35:33.127919Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became pre-candidate at term 1"} {"level":"info","ts":"2026-05-19T13:35:33.127948Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e received MsgPreVoteResp from 380f6760faea5f9e at term 1"} {"level":"info","ts":"2026-05-19T13:35:33.127964Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became candidate at term 2"} {"level":"info","ts":"2026-05-19T13:35:33.127971Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e received MsgVoteResp from 380f6760faea5f9e at term 2"} {"level":"info","ts":"2026-05-19T13:35:33.12798Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became leader at term 2"} {"level":"info","ts":"2026-05-19T13:35:33.127988Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 380f6760faea5f9e elected leader 380f6760faea5f9e at term 2"} {"level":"info","ts":"2026-05-19T13:35:33.130204Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"380f6760faea5f9e","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.222:2379]}","request-path":"/0/members/380f6760faea5f9e/attributes","cluster-id":"b87e8aca83a17eab","publish-timeout":"7s"} {"level":"info","ts":"2026-05-19T13:35:33.130222Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-19T13:35:33.130265Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-19T13:35:33.13025Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T13:35:33.131076Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-19T13:35:33.13116Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-19T13:35:33.131351Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"b87e8aca83a17eab","local-member-id":"380f6760faea5f9e","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T13:35:33.131505Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T13:35:33.131594Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T13:35:33.134079Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-19T13:35:33.135283Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.222:2379"} {"level":"info","ts":"2026-05-19T13:35:43.784875Z","caller":"traceutil/trace.go:171","msg":"trace[146131071] linearizableReadLoop","detail":"{readStateIndex:362; appliedIndex:361; }","duration":"114.105103ms","start":"2026-05-19T13:35:43.670733Z","end":"2026-05-19T13:35:43.784838Z","steps":["trace[146131071] 'read index received' (duration: 113.832965ms)","trace[146131071] 'applied index is now lower than readState.Index' (duration: 271.078µs)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:35:43.785072Z","caller":"traceutil/trace.go:171","msg":"trace[35633383] transaction","detail":"{read_only:false; response_revision:351; number_of_response:1; }","duration":"156.217243ms","start":"2026-05-19T13:35:43.628844Z","end":"2026-05-19T13:35:43.785061Z","steps":["trace[35633383] 'process raft request' (duration: 155.819253ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:43.785418Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.602346ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/daemon-set-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-05-19T13:35:43.785559Z","caller":"traceutil/trace.go:171","msg":"trace[1516355367] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/daemon-set-controller; range_end:; response_count:1; response_revision:351; }","duration":"114.867644ms","start":"2026-05-19T13:35:43.670669Z","end":"2026-05-19T13:35:43.785537Z","steps":["trace[1516355367] 'agreement among raft nodes before linearized reading' (duration: 114.587436ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.097233Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"223.726305ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-19T13:35:44.097497Z","caller":"traceutil/trace.go:171","msg":"trace[1251258779] transaction","detail":"{read_only:false; response_revision:352; number_of_response:1; }","duration":"303.504067ms","start":"2026-05-19T13:35:43.79384Z","end":"2026-05-19T13:35:44.097344Z","steps":["trace[1251258779] 'process raft request' (duration: 78.495756ms)","trace[1251258779] 'compare' (duration: 223.452088ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:35:44.097563Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.793812Z","time spent":"303.722613ms","remote":"127.0.0.1:46670","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":649,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T13:35:44.222091Z","caller":"traceutil/trace.go:171","msg":"trace[165104474] transaction","detail":"{read_only:false; response_revision:353; number_of_response:1; }","duration":"427.540577ms","start":"2026-05-19T13:35:43.794523Z","end":"2026-05-19T13:35:44.222063Z","steps":["trace[165104474] 'process raft request' (duration: 407.209661ms)","trace[165104474] 'compare' (duration: 20.13545ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:35:44.222101Z","caller":"traceutil/trace.go:171","msg":"trace[889840827] linearizableReadLoop","detail":"{readStateIndex:365; appliedIndex:362; }","duration":"401.745975ms","start":"2026-05-19T13:35:43.820293Z","end":"2026-05-19T13:35:44.222039Z","steps":["trace[889840827] 'read index received' (duration: 52.056057ms)","trace[889840827] 'applied index is now lower than readState.Index' (duration: 349.688628ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:35:44.222316Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.794505Z","time spent":"427.683241ms","remote":"127.0.0.1:47054","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2150,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T13:35:44.222465Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.716833ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-19T13:35:44.222521Z","caller":"traceutil/trace.go:171","msg":"trace[35706173] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/certificate-controller; range_end:; response_count:1; response_revision:354; }","duration":"202.821735ms","start":"2026-05-19T13:35:44.019682Z","end":"2026-05-19T13:35:44.222503Z","steps":["trace[35706173] 'agreement among raft nodes before linearized reading' (duration: 202.661521ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.222511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"351.516528ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-05-19T13:35:44.222552Z","caller":"traceutil/trace.go:171","msg":"trace[1708050352] transaction","detail":"{read_only:false; response_revision:354; number_of_response:1; }","duration":"427.732643ms","start":"2026-05-19T13:35:43.794676Z","end":"2026-05-19T13:35:44.222409Z","steps":["trace[1708050352] 'process raft request' (duration: 427.30664ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.222621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"302.404869ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-19T13:35:44.222645Z","caller":"traceutil/trace.go:171","msg":"trace[1149621451] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/deployment-controller; range_end:; response_count:1; response_revision:354; }","duration":"351.694952ms","start":"2026-05-19T13:35:43.870922Z","end":"2026-05-19T13:35:44.222617Z","steps":["trace[1149621451] 'agreement among raft nodes before linearized reading' (duration: 351.424915ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.222635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.522413ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/bootstrap-signer\" ","response":"range_response_count:1 size:197"} {"level":"warn","ts":"2026-05-19T13:35:44.222707Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.870907Z","time spent":"351.787755ms","remote":"127.0.0.1:46776","response type":"/etcdserverpb.KV/Range","request count":0,"request size":61,"response count":1,"response size":230,"request content":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" "} {"level":"warn","ts":"2026-05-19T13:35:44.222722Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.794669Z","time spent":"427.974699ms","remote":"127.0.0.1:46744","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":596,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T13:35:44.222763Z","caller":"traceutil/trace.go:171","msg":"trace[1872514881] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/bootstrap-signer; range_end:; response_count:1; response_revision:354; }","duration":"251.694598ms","start":"2026-05-19T13:35:43.971039Z","end":"2026-05-19T13:35:44.222733Z","steps":["trace[1872514881] 'agreement among raft nodes before linearized reading' (duration: 251.38951ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.222748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"402.414314ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" ","response":"range_response_count:1 size:214"} {"level":"info","ts":"2026-05-19T13:35:44.222675Z","caller":"traceutil/trace.go:171","msg":"trace[544337046] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/root-ca-cert-publisher; range_end:; response_count:1; response_revision:354; }","duration":"302.45486ms","start":"2026-05-19T13:35:43.920202Z","end":"2026-05-19T13:35:44.222657Z","steps":["trace[544337046] 'agreement among raft nodes before linearized reading' (duration: 302.366188ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:35:44.222891Z","caller":"traceutil/trace.go:171","msg":"trace[1444854251] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpointslice-controller; range_end:; response_count:1; response_revision:354; }","duration":"402.64504ms","start":"2026-05-19T13:35:43.820216Z","end":"2026-05-19T13:35:44.222861Z","steps":["trace[1444854251] 'agreement among raft nodes before linearized reading' (duration: 402.308551ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:35:44.222958Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.820184Z","time spent":"402.763483ms","remote":"127.0.0.1:46776","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":1,"response size":237,"request content":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" "} {"level":"warn","ts":"2026-05-19T13:35:44.223019Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:35:43.920118Z","time spent":"302.806129ms","remote":"127.0.0.1:46776","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":1,"response size":232,"request content":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" "} {"level":"info","ts":"2026-05-19T13:36:09.654614Z","caller":"traceutil/trace.go:171","msg":"trace[2143224115] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"154.743846ms","start":"2026-05-19T13:36:09.499838Z","end":"2026-05-19T13:36:09.654581Z","steps":["trace[2143224115] 'process raft request' (duration: 154.555531ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:36:10.677347Z","caller":"traceutil/trace.go:171","msg":"trace[115023200] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"160.684944ms","start":"2026-05-19T13:36:10.516629Z","end":"2026-05-19T13:36:10.677314Z","steps":["trace[115023200] 'process raft request' (duration: 160.510579ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:36:10.972688Z","caller":"traceutil/trace.go:171","msg":"trace[857572773] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"167.817107ms","start":"2026-05-19T13:36:10.804826Z","end":"2026-05-19T13:36:10.972643Z","steps":["trace[857572773] 'process raft request' (duration: 162.949839ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:36:11.548056Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"363.892358ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-19T13:36:11.548321Z","caller":"traceutil/trace.go:171","msg":"trace[351827860] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"565.381531ms","start":"2026-05-19T13:36:10.982867Z","end":"2026-05-19T13:36:11.548249Z","steps":["trace[351827860] 'process raft request' (duration: 201.02642ms)","trace[351827860] 'compare' (duration: 363.702543ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:36:11.548596Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:36:10.982848Z","time spent":"565.597858ms","remote":"127.0.0.1:46830","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-05-19T13:36:11.54859Z","caller":"traceutil/trace.go:171","msg":"trace[839236074] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"515.422963ms","start":"2026-05-19T13:36:11.033125Z","end":"2026-05-19T13:36:11.548548Z","steps":["trace[839236074] 'process raft request' (duration: 515.034752ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:36:11.548784Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:36:11.033103Z","time spent":"515.589157ms","remote":"127.0.0.1:47062","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-05-19T13:37:43.194213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.534296ms","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-05-19T13:37:43.194302Z","caller":"traceutil/trace.go:171","msg":"trace[1656220091] range","detail":"{range_begin:/registry/priorityclasses/; range_end:/registry/priorityclasses0; response_count:0; response_revision:1840; }","duration":"173.697522ms","start":"2026-05-19T13:37:43.020589Z","end":"2026-05-19T13:37:43.194287Z","steps":["trace[1656220091] 'count revisions from in-memory index tree' (duration: 173.410043ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.194514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.717306ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/datadir-percona-xtradb-pxc-0.18b0fb0732fb48db\" ","response":"range_response_count:1 size:982"} {"level":"warn","ts":"2026-05-19T13:37:43.19456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.383779ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-0ffdb0d7-424f-4680-b61e-bb7c75fdbe55\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-05-19T13:37:43.194602Z","caller":"traceutil/trace.go:171","msg":"trace[412232134] range","detail":"{range_begin:/registry/events/openstack/datadir-percona-xtradb-pxc-0.18b0fb0732fb48db; range_end:; response_count:1; response_revision:1840; }","duration":"163.83591ms","start":"2026-05-19T13:37:43.030744Z","end":"2026-05-19T13:37:43.19458Z","steps":["trace[412232134] 'range keys from in-memory index tree' (duration: 163.53802ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.194628Z","caller":"traceutil/trace.go:171","msg":"trace[2014841595] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-0ffdb0d7-424f-4680-b61e-bb7c75fdbe55; range_end:; response_count:1; response_revision:1840; }","duration":"170.506983ms","start":"2026-05-19T13:37:43.024102Z","end":"2026-05-19T13:37:43.194609Z","steps":["trace[2014841595] 'range keys from in-memory index tree' (duration: 170.134293ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.19467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.681411ms","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-05-19T13:37:43.195218Z","caller":"traceutil/trace.go:171","msg":"trace[615578119] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1840; }","duration":"259.279737ms","start":"2026-05-19T13:37:42.935916Z","end":"2026-05-19T13:37:43.195196Z","steps":["trace[615578119] 'range keys from in-memory index tree' (duration: 258.434395ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.195331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"259.797172ms","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-05-19T13:37:43.195396Z","caller":"traceutil/trace.go:171","msg":"trace[1612829255] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1840; }","duration":"259.865203ms","start":"2026-05-19T13:37:42.935517Z","end":"2026-05-19T13:37:43.195382Z","steps":["trace[1612829255] 'range keys from in-memory index tree' (duration: 259.618767ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.202667Z","caller":"traceutil/trace.go:171","msg":"trace[719890524] transaction","detail":"{read_only:false; response_revision:1841; number_of_response:1; }","duration":"146.570131ms","start":"2026-05-19T13:37:43.056058Z","end":"2026-05-19T13:37:43.202628Z","steps":["trace[719890524] 'process raft request' (duration: 146.428427ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.34882Z","caller":"traceutil/trace.go:171","msg":"trace[1384791894] linearizableReadLoop","detail":"{readStateIndex:1912; appliedIndex:1910; }","duration":"149.235776ms","start":"2026-05-19T13:37:43.19955Z","end":"2026-05-19T13:37:43.348786Z","steps":["trace[1384791894] 'read index received' (duration: 2.943831ms)","trace[1384791894] 'applied index is now lower than readState.Index' (duration: 146.290305ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:37:43.348972Z","caller":"traceutil/trace.go:171","msg":"trace[137166310] transaction","detail":"{read_only:false; response_revision:1843; number_of_response:1; }","duration":"149.138883ms","start":"2026-05-19T13:37:43.199819Z","end":"2026-05-19T13:37:43.348958Z","steps":["trace[137166310] 'process raft request' (duration: 148.830595ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.349033Z","caller":"traceutil/trace.go:171","msg":"trace[1321102663] transaction","detail":"{read_only:false; response_revision:1844; number_of_response:1; }","duration":"148.871955ms","start":"2026-05-19T13:37:43.200113Z","end":"2026-05-19T13:37:43.348985Z","steps":["trace[1321102663] 'process raft request' (duration: 148.619878ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.349168Z","caller":"traceutil/trace.go:171","msg":"trace[769714095] transaction","detail":"{read_only:false; response_revision:1842; number_of_response:1; }","duration":"151.820816ms","start":"2026-05-19T13:37:43.197245Z","end":"2026-05-19T13:37:43.349066Z","steps":["trace[769714095] 'process raft request' (duration: 98.910224ms)","trace[769714095] 'compare' (duration: 52.277684ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:37:43.349225Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.641677ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-0ffdb0d7-424f-4680-b61e-bb7c75fdbe55\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-05-19T13:37:43.349566Z","caller":"traceutil/trace.go:171","msg":"trace[274135114] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-0ffdb0d7-424f-4680-b61e-bb7c75fdbe55; range_end:; response_count:1; response_revision:1844; }","duration":"150.059718ms","start":"2026-05-19T13:37:43.199482Z","end":"2026-05-19T13:37:43.349542Z","steps":["trace[274135114] 'agreement among raft nodes before linearized reading' (duration: 149.535694ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.398586Z","caller":"traceutil/trace.go:171","msg":"trace[672070215] transaction","detail":"{read_only:false; response_revision:1845; number_of_response:1; }","duration":"195.551975ms","start":"2026-05-19T13:37:43.202998Z","end":"2026-05-19T13:37:43.39855Z","steps":["trace[672070215] 'process raft request' (duration: 194.66088ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.398773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.194488ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T13:37:43.398861Z","caller":"traceutil/trace.go:171","msg":"trace[1536877574] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1845; }","duration":"198.313011ms","start":"2026-05-19T13:37:43.20053Z","end":"2026-05-19T13:37:43.398843Z","steps":["trace[1536877574] 'agreement among raft nodes before linearized reading' (duration: 198.154096ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.399117Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.58957ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T13:37:43.399176Z","caller":"traceutil/trace.go:171","msg":"trace[773357353] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:1845; }","duration":"160.723063ms","start":"2026-05-19T13:37:43.238434Z","end":"2026-05-19T13:37:43.399157Z","steps":["trace[773357353] 'agreement among raft nodes before linearized reading' (duration: 160.60104ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.65456Z","caller":"traceutil/trace.go:171","msg":"trace[490707625] linearizableReadLoop","detail":"{readStateIndex:1916; appliedIndex:1915; }","duration":"191.840743ms","start":"2026-05-19T13:37:43.462689Z","end":"2026-05-19T13:37:43.654529Z","steps":["trace[490707625] 'read index received' (duration: 112.452278ms)","trace[490707625] 'applied index is now lower than readState.Index' (duration: 79.386985ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:37:43.654918Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.207594ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-19T13:37:43.655049Z","caller":"traceutil/trace.go:171","msg":"trace[1370553277] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:1846; }","duration":"192.403208ms","start":"2026-05-19T13:37:43.462628Z","end":"2026-05-19T13:37:43.655031Z","steps":["trace[1370553277] 'agreement among raft nodes before linearized reading' (duration: 192.211773ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:37:43.655126Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.283685ms","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-05-19T13:37:43.655188Z","caller":"traceutil/trace.go:171","msg":"trace[323014834] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1846; }","duration":"145.387978ms","start":"2026-05-19T13:37:43.509785Z","end":"2026-05-19T13:37:43.655173Z","steps":["trace[323014834] 'agreement among raft nodes before linearized reading' (duration: 145.171652ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:37:43.655188Z","caller":"traceutil/trace.go:171","msg":"trace[1645964324] transaction","detail":"{read_only:false; response_revision:1846; number_of_response:1; }","duration":"213.727897ms","start":"2026-05-19T13:37:43.441426Z","end":"2026-05-19T13:37:43.655154Z","steps":["trace[1645964324] 'process raft request' (duration: 133.786687ms)","trace[1645964324] 'compare' (duration: 79.168919ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:38:32.897521Z","caller":"traceutil/trace.go:171","msg":"trace[444418074] transaction","detail":"{read_only:false; response_revision:2169; number_of_response:1; }","duration":"159.843308ms","start":"2026-05-19T13:38:32.737656Z","end":"2026-05-19T13:38:32.8975Z","steps":["trace[444418074] 'process raft request' (duration: 159.706104ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:39:50.739915Z","caller":"traceutil/trace.go:171","msg":"trace[684771103] transaction","detail":"{read_only:false; response_revision:2640; number_of_response:1; }","duration":"155.456048ms","start":"2026-05-19T13:39:50.584416Z","end":"2026-05-19T13:39:50.739872Z","steps":["trace[684771103] 'process raft request' (duration: 155.106718ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:39:50.86013Z","caller":"traceutil/trace.go:171","msg":"trace[996157392] transaction","detail":"{read_only:false; response_revision:2641; number_of_response:1; }","duration":"114.652437ms","start":"2026-05-19T13:39:50.745447Z","end":"2026-05-19T13:39:50.8601Z","steps":["trace[996157392] 'process raft request' (duration: 108.67073ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:39:56.315774Z","caller":"traceutil/trace.go:171","msg":"trace[2080951992] transaction","detail":"{read_only:false; response_revision:2668; number_of_response:1; }","duration":"103.153706ms","start":"2026-05-19T13:39:56.212593Z","end":"2026-05-19T13:39:56.315747Z","steps":["trace[2080951992] 'process raft request' (duration: 102.988091ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:39:56.502088Z","caller":"traceutil/trace.go:171","msg":"trace[1618845205] linearizableReadLoop","detail":"{readStateIndex:2768; appliedIndex:2766; }","duration":"159.874586ms","start":"2026-05-19T13:39:56.342184Z","end":"2026-05-19T13:39:56.502059Z","steps":["trace[1618845205] 'read index received' (duration: 83.649985ms)","trace[1618845205] 'applied index is now lower than readState.Index' (duration: 76.222981ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:39:56.502203Z","caller":"traceutil/trace.go:171","msg":"trace[2024383510] transaction","detail":"{read_only:false; response_revision:2670; number_of_response:1; }","duration":"164.069058ms","start":"2026-05-19T13:39:56.338095Z","end":"2026-05-19T13:39:56.502164Z","steps":["trace[2024383510] 'process raft request' (duration: 163.80916ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:39:56.502384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.168745ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:556"} {"level":"info","ts":"2026-05-19T13:39:56.502437Z","caller":"traceutil/trace.go:171","msg":"trace[122260373] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2670; }","duration":"160.265058ms","start":"2026-05-19T13:39:56.342156Z","end":"2026-05-19T13:39:56.502421Z","steps":["trace[122260373] 'agreement among raft nodes before linearized reading' (duration: 160.062302ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:42:42.164578Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.989504ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-19T13:42:42.16489Z","caller":"traceutil/trace.go:171","msg":"trace[1335322286] transaction","detail":"{read_only:false; response_revision:3729; number_of_response:1; }","duration":"339.735174ms","start":"2026-05-19T13:42:41.825092Z","end":"2026-05-19T13:42:42.164827Z","steps":["trace[1335322286] 'process raft request' (duration: 216.395341ms)","trace[1335322286] 'compare' (duration: 122.656733ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:42:42.16489Z","caller":"traceutil/trace.go:171","msg":"trace[805408982] linearizableReadLoop","detail":"{readStateIndex:3867; appliedIndex:3866; }","duration":"234.564814ms","start":"2026-05-19T13:42:41.930262Z","end":"2026-05-19T13:42:42.164827Z","steps":["trace[805408982] 'read index received' (duration: 111.343814ms)","trace[805408982] 'applied index is now lower than readState.Index' (duration: 123.21103ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:42:42.165116Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:42:41.825059Z","time spent":"339.94077ms","remote":"127.0.0.1:46830","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-19T13:42:42.169826Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"239.526883ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:572"} {"level":"info","ts":"2026-05-19T13:42:42.169945Z","caller":"traceutil/trace.go:171","msg":"trace[2060339484] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:3729; }","duration":"239.711128ms","start":"2026-05-19T13:42:41.930204Z","end":"2026-05-19T13:42:42.169915Z","steps":["trace[2060339484] 'agreement among raft nodes before linearized reading' (duration: 234.743208ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:44:26.959657Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.56877ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:572"} {"level":"info","ts":"2026-05-19T13:44:26.959788Z","caller":"traceutil/trace.go:171","msg":"trace[1054338818] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:5188; }","duration":"142.758116ms","start":"2026-05-19T13:44:26.816997Z","end":"2026-05-19T13:44:26.959755Z","steps":["trace[1054338818] 'range keys from in-memory index tree' (duration: 142.273732ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:44:35.647981Z","caller":"traceutil/trace.go:171","msg":"trace[1520431516] linearizableReadLoop","detail":"{readStateIndex:5533; appliedIndex:5532; }","duration":"316.176191ms","start":"2026-05-19T13:44:35.331772Z","end":"2026-05-19T13:44:35.647948Z","steps":["trace[1520431516] 'read index received' (duration: 315.885613ms)","trace[1520431516] 'applied index is now lower than readState.Index' (duration: 288.268µs)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:44:35.648222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"316.433909ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/storage-loki-0\" ","response":"range_response_count:1 size:1781"} {"level":"info","ts":"2026-05-19T13:44:35.648282Z","caller":"traceutil/trace.go:171","msg":"trace[487540496] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/storage-loki-0; range_end:; response_count:1; response_revision:5334; }","duration":"316.552222ms","start":"2026-05-19T13:44:35.331715Z","end":"2026-05-19T13:44:35.648267Z","steps":["trace[487540496] 'agreement among raft nodes before linearized reading' (duration: 316.352877ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:44:35.648326Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:44:35.331695Z","time spent":"316.623005ms","remote":"127.0.0.1:46734","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":1804,"request content":"key:\"/registry/persistentvolumeclaims/monitoring/storage-loki-0\" "} {"level":"info","ts":"2026-05-19T13:44:35.648193Z","caller":"traceutil/trace.go:171","msg":"trace[27437810] transaction","detail":"{read_only:false; response_revision:5334; number_of_response:1; }","duration":"338.659408ms","start":"2026-05-19T13:44:35.309383Z","end":"2026-05-19T13:44:35.648042Z","steps":["trace[27437810] 'process raft request' (duration: 338.393371ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:44:35.648653Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T13:44:35.309361Z","time spent":"339.196403ms","remote":"127.0.0.1:46766","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3751,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-19T13:44:35.830018Z","caller":"traceutil/trace.go:171","msg":"trace[1656636570] transaction","detail":"{read_only:false; response_revision:5335; number_of_response:1; }","duration":"141.90168ms","start":"2026-05-19T13:44:35.688087Z","end":"2026-05-19T13:44:35.829988Z","steps":["trace[1656636570] 'process raft request' (duration: 98.927664ms)","trace[1656636570] 'compare' (duration: 42.850493ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:44:37.52464Z","caller":"traceutil/trace.go:171","msg":"trace[202046377] transaction","detail":"{read_only:false; response_revision:5351; number_of_response:1; }","duration":"118.701134ms","start":"2026-05-19T13:44:37.405911Z","end":"2026-05-19T13:44:37.524612Z","steps":["trace[202046377] 'process raft request' (duration: 118.522999ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:44:46.600802Z","caller":"traceutil/trace.go:171","msg":"trace[1650757144] transaction","detail":"{read_only:false; response_revision:5512; number_of_response:1; }","duration":"114.986801ms","start":"2026-05-19T13:44:46.485779Z","end":"2026-05-19T13:44:46.600766Z","steps":["trace[1650757144] 'process raft request' (duration: 74.382861ms)","trace[1650757144] 'compare' (duration: 40.458206ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:44:46.653894Z","caller":"traceutil/trace.go:171","msg":"trace[609513622] transaction","detail":"{read_only:false; response_revision:5513; number_of_response:1; }","duration":"168.071118ms","start":"2026-05-19T13:44:46.485797Z","end":"2026-05-19T13:44:46.653868Z","steps":["trace[609513622] 'process raft request' (duration: 167.829232ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:44:46.654011Z","caller":"traceutil/trace.go:171","msg":"trace[512509630] transaction","detail":"{read_only:false; response_revision:5514; number_of_response:1; }","duration":"167.191824ms","start":"2026-05-19T13:44:46.486781Z","end":"2026-05-19T13:44:46.653973Z","steps":["trace[512509630] 'process raft request' (duration: 167.009849ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:44:46.653926Z","caller":"traceutil/trace.go:171","msg":"trace[300471062] linearizableReadLoop","detail":"{readStateIndex:5719; appliedIndex:5715; }","duration":"164.205291ms","start":"2026-05-19T13:44:46.489691Z","end":"2026-05-19T13:44:46.653896Z","steps":["trace[300471062] 'read index received' (duration: 70.455612ms)","trace[300471062] 'applied index is now lower than readState.Index' (duration: 93.748599ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:44:46.654137Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.412637ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.222\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-05-19T13:44:46.654056Z","caller":"traceutil/trace.go:171","msg":"trace[219336741] transaction","detail":"{read_only:false; response_revision:5515; number_of_response:1; }","duration":"167.164443ms","start":"2026-05-19T13:44:46.48685Z","end":"2026-05-19T13:44:46.654014Z","steps":["trace[219336741] 'process raft request' (duration: 166.998429ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:44:46.654204Z","caller":"traceutil/trace.go:171","msg":"trace[1110165799] range","detail":"{range_begin:/registry/masterleases/199.204.45.222; range_end:; response_count:1; response_revision:5515; }","duration":"164.52657ms","start":"2026-05-19T13:44:46.489659Z","end":"2026-05-19T13:44:46.654186Z","steps":["trace[1110165799] 'agreement among raft nodes before linearized reading' (duration: 164.326985ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:44:46.679298Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.514246ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1865"} {"level":"info","ts":"2026-05-19T13:44:46.679379Z","caller":"traceutil/trace.go:171","msg":"trace[826933895] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:5516; }","duration":"129.640969ms","start":"2026-05-19T13:44:46.549718Z","end":"2026-05-19T13:44:46.679359Z","steps":["trace[826933895] 'agreement among raft nodes before linearized reading' (duration: 129.439023ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:45:33.39716Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2865} {"level":"info","ts":"2026-05-19T13:45:33.469797Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2865,"took":"70.610455ms","hash":742136872,"current-db-size-bytes":56582144,"current-db-size":"57 MB","current-db-size-in-use-bytes":32661504,"current-db-size-in-use":"33 MB"} {"level":"info","ts":"2026-05-19T13:45:33.469878Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":742136872,"revision":2865,"compact-revision":-1} {"level":"info","ts":"2026-05-19T13:50:33.407491Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5905} {"level":"info","ts":"2026-05-19T13:50:33.499336Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5905,"took":"90.129951ms","hash":2275095590,"current-db-size-bytes":56582144,"current-db-size":"57 MB","current-db-size-in-use-bytes":25010176,"current-db-size-in-use":"25 MB"} {"level":"info","ts":"2026-05-19T13:50:33.499388Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2275095590,"revision":5905,"compact-revision":2865} {"level":"info","ts":"2026-05-19T13:50:38.643422Z","caller":"traceutil/trace.go:171","msg":"trace[1886914824] transaction","detail":"{read_only:false; response_revision:8178; number_of_response:1; }","duration":"190.714823ms","start":"2026-05-19T13:50:38.452679Z","end":"2026-05-19T13:50:38.643394Z","steps":["trace[1886914824] 'process raft request' (duration: 190.470296ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:50:50.177707Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.179882ms","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-05-19T13:50:50.177792Z","caller":"traceutil/trace.go:171","msg":"trace[1798486884] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8234; }","duration":"249.316886ms","start":"2026-05-19T13:50:49.928457Z","end":"2026-05-19T13:50:50.177774Z","steps":["trace[1798486884] 'range keys from in-memory index tree' (duration: 249.013947ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:50:50.177813Z","caller":"traceutil/trace.go:171","msg":"trace[1930253714] transaction","detail":"{read_only:false; response_revision:8235; number_of_response:1; }","duration":"229.659878ms","start":"2026-05-19T13:50:49.948124Z","end":"2026-05-19T13:50:50.177784Z","steps":["trace[1930253714] 'process raft request' (duration: 139.672671ms)","trace[1930253714] 'compare' (duration: 89.574666ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:50:50.83842Z","caller":"traceutil/trace.go:171","msg":"trace[1635506359] transaction","detail":"{read_only:false; response_revision:8239; number_of_response:1; }","duration":"141.572564ms","start":"2026-05-19T13:50:50.696817Z","end":"2026-05-19T13:50:50.83839Z","steps":["trace[1635506359] 'process raft request' (duration: 141.305476ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:19.151704Z","caller":"traceutil/trace.go:171","msg":"trace[2061105127] linearizableReadLoop","detail":"{readStateIndex:8745; appliedIndex:8744; }","duration":"121.00636ms","start":"2026-05-19T13:51:19.030671Z","end":"2026-05-19T13:51:19.151678Z","steps":["trace[2061105127] 'read index received' (duration: 120.818195ms)","trace[2061105127] 'applied index is now lower than readState.Index' (duration: 186.785µs)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:51:19.151749Z","caller":"traceutil/trace.go:171","msg":"trace[1778807938] transaction","detail":"{read_only:false; response_revision:8443; number_of_response:1; }","duration":"186.106075ms","start":"2026-05-19T13:51:18.965616Z","end":"2026-05-19T13:51:19.151722Z","steps":["trace[1778807938] 'process raft request' (duration: 185.92226ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:19.151883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.176636ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/schemareplications/\" range_end:\"/registry/rabbitmq.com/schemareplications0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T13:51:19.151947Z","caller":"traceutil/trace.go:171","msg":"trace[1698812772] range","detail":"{range_begin:/registry/rabbitmq.com/schemareplications/; range_end:/registry/rabbitmq.com/schemareplications0; response_count:0; response_revision:8443; }","duration":"121.290528ms","start":"2026-05-19T13:51:19.030642Z","end":"2026-05-19T13:51:19.151932Z","steps":["trace[1698812772] 'agreement among raft nodes before linearized reading' (duration: 121.161975ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:31.502683Z","caller":"traceutil/trace.go:171","msg":"trace[1038553781] linearizableReadLoop","detail":"{readStateIndex:8824; appliedIndex:8822; }","duration":"108.077411ms","start":"2026-05-19T13:51:31.394586Z","end":"2026-05-19T13:51:31.502664Z","steps":["trace[1038553781] 'read index received' (duration: 21.088757ms)","trace[1038553781] 'applied index is now lower than readState.Index' (duration: 86.987964ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:51:31.502786Z","caller":"traceutil/trace.go:171","msg":"trace[575451175] transaction","detail":"{read_only:false; number_of_response:1; response_revision:8520; }","duration":"114.951742ms","start":"2026-05-19T13:51:31.387817Z","end":"2026-05-19T13:51:31.502769Z","steps":["trace[575451175] 'process raft request' (duration: 87.350153ms)","trace[575451175] 'compare' (duration: 27.409304ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:51:31.502936Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.338367ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:572"} {"level":"info","ts":"2026-05-19T13:51:31.502982Z","caller":"traceutil/trace.go:171","msg":"trace[1535169767] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:8520; }","duration":"108.42876ms","start":"2026-05-19T13:51:31.394545Z","end":"2026-05-19T13:51:31.502974Z","steps":["trace[1535169767] 'agreement among raft nodes before linearized reading' (duration: 108.234565ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:31.503165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.401263ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/cert-manager-controller-issuers\" ","response":"range_response_count:1 size:1189"} {"level":"info","ts":"2026-05-19T13:51:31.503481Z","caller":"traceutil/trace.go:171","msg":"trace[1200524649] range","detail":"{range_begin:/registry/clusterroles/cert-manager-controller-issuers; range_end:; response_count:1; response_revision:8520; }","duration":"102.773594ms","start":"2026-05-19T13:51:31.400669Z","end":"2026-05-19T13:51:31.503443Z","steps":["trace[1200524649] 'agreement among raft nodes before linearized reading' (duration: 102.198477ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:31.871269Z","caller":"traceutil/trace.go:171","msg":"trace[147813354] transaction","detail":"{read_only:false; response_revision:8523; number_of_response:1; }","duration":"110.418537ms","start":"2026-05-19T13:51:31.760824Z","end":"2026-05-19T13:51:31.871242Z","steps":["trace[147813354] 'process raft request' (duration: 58.407778ms)","trace[147813354] 'compare' (duration: 51.747062ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:51:32.182183Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.685442ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/cilium\" ","response":"range_response_count:1 size:1654"} {"level":"info","ts":"2026-05-19T13:51:32.18224Z","caller":"traceutil/trace.go:171","msg":"trace[1129828181] range","detail":"{range_begin:/registry/clusterroles/cilium; range_end:; response_count:1; response_revision:8523; }","duration":"204.782195ms","start":"2026-05-19T13:51:31.977447Z","end":"2026-05-19T13:51:32.182229Z","steps":["trace[1129828181] 'range keys from in-memory index tree' (duration: 204.60757ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.182378Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.71784ms","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-05-19T13:51:32.182397Z","caller":"traceutil/trace.go:171","msg":"trace[1304917272] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:8523; }","duration":"173.778162ms","start":"2026-05-19T13:51:32.008614Z","end":"2026-05-19T13:51:32.182393Z","steps":["trace[1304917272] 'range keys from in-memory index tree' (duration: 173.569396ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.182579Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.061432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/cilium-operator\" ","response":"range_response_count:1 size:2379"} {"level":"info","ts":"2026-05-19T13:51:32.182607Z","caller":"traceutil/trace.go:171","msg":"trace[1683966845] range","detail":"{range_begin:/registry/clusterroles/cilium-operator; range_end:; response_count:1; response_revision:8523; }","duration":"140.119593ms","start":"2026-05-19T13:51:32.042482Z","end":"2026-05-19T13:51:32.182601Z","steps":["trace[1683966845] 'range keys from in-memory index tree' (duration: 139.967879ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.182729Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.201066ms","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-05-19T13:51:32.182759Z","caller":"traceutil/trace.go:171","msg":"trace[2026847782] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:8523; }","duration":"121.278529ms","start":"2026-05-19T13:51:32.061476Z","end":"2026-05-19T13:51:32.182754Z","steps":["trace[2026847782] 'range keys from in-memory index tree' (duration: 121.047452ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.182851Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.606687ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/barbican-api-85bcc774df-29xrf.18b0fbbab15aff85\" ","response":"range_response_count:1 size:1135"} {"level":"info","ts":"2026-05-19T13:51:32.18287Z","caller":"traceutil/trace.go:171","msg":"trace[1286795099] range","detail":"{range_begin:/registry/events/openstack/barbican-api-85bcc774df-29xrf.18b0fbbab15aff85; range_end:; response_count:1; response_revision:8523; }","duration":"112.647759ms","start":"2026-05-19T13:51:32.070217Z","end":"2026-05-19T13:51:32.182865Z","steps":["trace[1286795099] 'range keys from in-memory index tree' (duration: 112.550756ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.318931Z","caller":"traceutil/trace.go:171","msg":"trace[792191186] transaction","detail":"{read_only:false; response_revision:8524; number_of_response:1; }","duration":"133.267463ms","start":"2026-05-19T13:51:32.185642Z","end":"2026-05-19T13:51:32.318909Z","steps":["trace[792191186] 'process raft request' (duration: 133.119459ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.328217Z","caller":"traceutil/trace.go:171","msg":"trace[425040307] transaction","detail":"{read_only:false; response_revision:8525; number_of_response:1; }","duration":"142.477389ms","start":"2026-05-19T13:51:32.18573Z","end":"2026-05-19T13:51:32.328207Z","steps":["trace[425040307] 'process raft request' (duration: 141.969025ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.328377Z","caller":"traceutil/trace.go:171","msg":"trace[1649115824] transaction","detail":"{read_only:false; response_revision:8526; number_of_response:1; }","duration":"141.210143ms","start":"2026-05-19T13:51:32.18716Z","end":"2026-05-19T13:51:32.32837Z","steps":["trace[1649115824] 'process raft request' (duration: 140.609887ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.328469Z","caller":"traceutil/trace.go:171","msg":"trace[59337247] transaction","detail":"{read_only:false; response_revision:8527; number_of_response:1; }","duration":"140.744311ms","start":"2026-05-19T13:51:32.187719Z","end":"2026-05-19T13:51:32.328463Z","steps":["trace[59337247] 'process raft request' (duration: 140.078453ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.606403Z","caller":"traceutil/trace.go:171","msg":"trace[111852451] transaction","detail":"{read_only:false; response_revision:8529; number_of_response:1; }","duration":"248.341018ms","start":"2026-05-19T13:51:32.358036Z","end":"2026-05-19T13:51:32.606377Z","steps":["trace[111852451] 'process raft request' (duration: 248.194054ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.606704Z","caller":"traceutil/trace.go:171","msg":"trace[1732618246] linearizableReadLoop","detail":"{readStateIndex:8834; appliedIndex:8834; }","duration":"208.483188ms","start":"2026-05-19T13:51:32.3982Z","end":"2026-05-19T13:51:32.606683Z","steps":["trace[1732618246] 'read index received' (duration: 208.475598ms)","trace[1732618246] 'applied index is now lower than readState.Index' (duration: 5.8µs)"],"step_count":2} {"level":"warn","ts":"2026-05-19T13:51:32.606906Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.692943ms","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-05-19T13:51:32.606935Z","caller":"traceutil/trace.go:171","msg":"trace[51301843] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8529; }","duration":"208.761376ms","start":"2026-05-19T13:51:32.398167Z","end":"2026-05-19T13:51:32.606928Z","steps":["trace[51301843] 'agreement among raft nodes before linearized reading' (duration: 208.595611ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.615892Z","caller":"traceutil/trace.go:171","msg":"trace[1349072978] transaction","detail":"{read_only:false; response_revision:8530; number_of_response:1; }","duration":"134.882257ms","start":"2026-05-19T13:51:32.480992Z","end":"2026-05-19T13:51:32.615874Z","steps":["trace[1349072978] 'process raft request' (duration: 134.781745ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.61605Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"194.239462ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:557"} {"level":"warn","ts":"2026-05-19T13:51:32.616067Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.347151ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/edit\" ","response":"range_response_count:1 size:4520"} {"level":"info","ts":"2026-05-19T13:51:32.616127Z","caller":"traceutil/trace.go:171","msg":"trace[137826420] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:8530; }","duration":"194.327594ms","start":"2026-05-19T13:51:32.421762Z","end":"2026-05-19T13:51:32.616089Z","steps":["trace[137826420] 'agreement among raft nodes before linearized reading' (duration: 194.086488ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:32.616132Z","caller":"traceutil/trace.go:171","msg":"trace[183620594] range","detail":"{range_begin:/registry/clusterroles/edit; range_end:; response_count:1; response_revision:8530; }","duration":"177.454064ms","start":"2026-05-19T13:51:32.438663Z","end":"2026-05-19T13:51:32.616118Z","steps":["trace[183620594] 'agreement among raft nodes before linearized reading' (duration: 177.260339ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:32.616477Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.565568ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/cluster-admin\" ","response":"range_response_count:1 size:553"} {"level":"info","ts":"2026-05-19T13:51:32.616622Z","caller":"traceutil/trace.go:171","msg":"trace[1617098548] range","detail":"{range_begin:/registry/clusterroles/cluster-admin; range_end:; response_count:1; response_revision:8530; }","duration":"168.254977ms","start":"2026-05-19T13:51:32.448347Z","end":"2026-05-19T13:51:32.616602Z","steps":["trace[1617098548] 'agreement among raft nodes before linearized reading' (duration: 167.530528ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:51:33.511784Z","caller":"traceutil/trace.go:171","msg":"trace[1079589075] linearizableReadLoop","detail":"{readStateIndex:8840; appliedIndex:8839; }","duration":"289.198987ms","start":"2026-05-19T13:51:33.222556Z","end":"2026-05-19T13:51:33.511755Z","steps":["trace[1079589075] 'read index received' (duration: 288.94322ms)","trace[1079589075] 'applied index is now lower than readState.Index' (duration: 254.467µs)"],"step_count":2} {"level":"info","ts":"2026-05-19T13:51:33.512227Z","caller":"traceutil/trace.go:171","msg":"trace[78562713] transaction","detail":"{read_only:false; response_revision:8535; number_of_response:1; }","duration":"294.253978ms","start":"2026-05-19T13:51:33.217958Z","end":"2026-05-19T13:51:33.512212Z","steps":["trace[78562713] 'process raft request' (duration: 293.64795ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:33.512577Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"290.00941ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-web-config\" ","response":"range_response_count:1 size:708"} {"level":"info","ts":"2026-05-19T13:51:33.512656Z","caller":"traceutil/trace.go:171","msg":"trace[1779912930] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-web-config; range_end:; response_count:1; response_revision:8535; }","duration":"290.074622ms","start":"2026-05-19T13:51:33.222536Z","end":"2026-05-19T13:51:33.51261Z","steps":["trace[1779912930] 'agreement among raft nodes before linearized reading' (duration: 289.925088ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:33.512923Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.300426ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/kube-prometheus-stack-grafana-clusterrole\" ","response":"range_response_count:1 size:958"} {"level":"info","ts":"2026-05-19T13:51:33.512967Z","caller":"traceutil/trace.go:171","msg":"trace[957312737] range","detail":"{range_begin:/registry/clusterroles/kube-prometheus-stack-grafana-clusterrole; range_end:; response_count:1; response_revision:8535; }","duration":"244.378398ms","start":"2026-05-19T13:51:33.268577Z","end":"2026-05-19T13:51:33.512956Z","steps":["trace[957312737] 'agreement among raft nodes before linearized reading' (duration: 244.270525ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:33.513398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.600091ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/federations/\" range_end:\"/registry/rabbitmq.com/federations0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T13:51:33.513462Z","caller":"traceutil/trace.go:171","msg":"trace[1223857583] range","detail":"{range_begin:/registry/rabbitmq.com/federations/; range_end:/registry/rabbitmq.com/federations0; response_count:0; response_revision:8535; }","duration":"227.709074ms","start":"2026-05-19T13:51:33.285739Z","end":"2026-05-19T13:51:33.513448Z","steps":["trace[1223857583] 'agreement among raft nodes before linearized reading' (duration: 227.59027ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:33.51369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.909172ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/kube-prometheus-stack-kube-state-metrics\" ","response":"range_response_count:1 size:2307"} {"level":"info","ts":"2026-05-19T13:51:33.513716Z","caller":"traceutil/trace.go:171","msg":"trace[1311755499] range","detail":"{range_begin:/registry/clusterroles/kube-prometheus-stack-kube-state-metrics; range_end:; response_count:1; response_revision:8535; }","duration":"230.967794ms","start":"2026-05-19T13:51:33.282741Z","end":"2026-05-19T13:51:33.513709Z","steps":["trace[1311755499] 'agreement among raft nodes before linearized reading' (duration: 230.863171ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T13:51:34.277659Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.13044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T13:51:34.2778Z","caller":"traceutil/trace.go:171","msg":"trace[125827639] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:8538; }","duration":"137.348166ms","start":"2026-05-19T13:51:34.140423Z","end":"2026-05-19T13:51:34.277771Z","steps":["trace[125827639] 'range keys from in-memory index tree' (duration: 137.038678ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T13:52:51.041153Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-000000000000247b.wal"}