{"level":"warn","ts":"2026-09-12T03:59:07.233592Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-12T03:59:07.233675Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.6: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://162.253.55.6:2380","--initial-cluster=instance=https://162.253.55.6:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.6:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.6: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-09-12T03:59:07.233731Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-12T03:59:07.233739Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.6:2380"]}
{"level":"info","ts":"2026-09-12T03:59:07.233759Z","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-09-12T03:59:07.234536Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.6:2379"]}
{"level":"info","ts":"2026-09-12T03:59:07.234605Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://162.253.55.6:2380"],"listen-peer-urls":["https://162.253.55.6:2380"],"advertise-client-urls":["https://162.253.55.6:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.6:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.6: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-09-12T03:59:07.241499Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.711426ms"}
{"level":"info","ts":"2026-09-12T03:59:07.250296Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"4e4145bf1b1a19cd","cluster-id":"e02e9056d18cef61"}
{"level":"info","ts":"2026-09-12T03:59:07.250458Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd switched to configuration voters=()"}
{"level":"info","ts":"2026-09-12T03:59:07.250548Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd became follower at term 0"}
{"level":"info","ts":"2026-09-12T03:59:07.250613Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 4e4145bf1b1a19cd [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-09-12T03:59:07.250709Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd became follower at term 1"}
{"level":"info","ts":"2026-09-12T03:59:07.25084Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd switched to configuration voters=(5638864895540337101)"}
{"level":"warn","ts":"2026-09-12T03:59:07.257133Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-09-12T03:59:07.259045Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-09-12T03:59:07.260612Z","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-09-12T03:59:07.262426Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"4e4145bf1b1a19cd","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-09-12T03:59:07.265893Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"4e4145bf1b1a19cd","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-09-12T03:59:07.266614Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd switched to configuration voters=(5638864895540337101)"}
{"level":"info","ts":"2026-09-12T03:59:07.26616Z","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-09-12T03:59:07.266713Z","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-09-12T03:59:07.266728Z","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-09-12T03:59:07.267205Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"e02e9056d18cef61","local-member-id":"4e4145bf1b1a19cd","added-peer-id":"4e4145bf1b1a19cd","added-peer-peer-urls":["https://162.253.55.6:2380"]}
{"level":"info","ts":"2026-09-12T03:59:07.268263Z","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-09-12T03:59:07.268441Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.6:2380"}
{"level":"info","ts":"2026-09-12T03:59:07.268519Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.6:2380"}
{"level":"info","ts":"2026-09-12T03:59:07.268603Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"4e4145bf1b1a19cd","initial-advertise-peer-urls":["https://162.253.55.6:2380"],"listen-peer-urls":["https://162.253.55.6:2380"],"advertise-client-urls":["https://162.253.55.6:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.6:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-09-12T03:59:07.268635Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-09-12T03:59:08.051274Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd is starting a new election at term 1"}
{"level":"info","ts":"2026-09-12T03:59:08.051347Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd became pre-candidate at term 1"}
{"level":"info","ts":"2026-09-12T03:59:08.051395Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd received MsgPreVoteResp from 4e4145bf1b1a19cd at term 1"}
{"level":"info","ts":"2026-09-12T03:59:08.051446Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd became candidate at term 2"}
{"level":"info","ts":"2026-09-12T03:59:08.051467Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd received MsgVoteResp from 4e4145bf1b1a19cd at term 2"}
{"level":"info","ts":"2026-09-12T03:59:08.051487Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e4145bf1b1a19cd became leader at term 2"}
{"level":"info","ts":"2026-09-12T03:59:08.051509Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 4e4145bf1b1a19cd elected leader 4e4145bf1b1a19cd at term 2"}
{"level":"info","ts":"2026-09-12T03:59:08.05269Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-12T03:59:08.053584Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"4e4145bf1b1a19cd","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.6:2379]}","request-path":"/0/members/4e4145bf1b1a19cd/attributes","cluster-id":"e02e9056d18cef61","publish-timeout":"7s"}
{"level":"info","ts":"2026-09-12T03:59:08.053784Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-12T03:59:08.053881Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-12T03:59:08.056736Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.6:2379"}
{"level":"info","ts":"2026-09-12T03:59:08.056853Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-09-12T03:59:08.056906Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-09-12T03:59:08.065279Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-09-12T03:59:08.069973Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"e02e9056d18cef61","local-member-id":"4e4145bf1b1a19cd","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-12T03:59:08.07015Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-12T03:59:08.070193Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-12T03:59:23.832292Z","caller":"traceutil/trace.go:171","msg":"trace[396233961] linearizableReadLoop","detail":"{readStateIndex:427; appliedIndex:425; }","duration":"133.628017ms","start":"2026-09-12T03:59:23.69864Z","end":"2026-09-12T03:59:23.832268Z","steps":["trace[396233961] 'read index received'  (duration: 48.223074ms)","trace[396233961] 'applied index is now lower than readState.Index'  (duration: 85.403763ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T03:59:23.832392Z","caller":"traceutil/trace.go:171","msg":"trace[2059888524] transaction","detail":"{read_only:false; response_revision:416; number_of_response:1; }","duration":"160.514586ms","start":"2026-09-12T03:59:23.671823Z","end":"2026-09-12T03:59:23.832337Z","steps":["trace[2059888524] 'process raft request'  (duration: 155.916107ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T03:59:23.832474Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.806283ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T03:59:23.832586Z","caller":"traceutil/trace.go:171","msg":"trace[816619828] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:416; }","duration":"133.957169ms","start":"2026-09-12T03:59:23.698609Z","end":"2026-09-12T03:59:23.832566Z","steps":["trace[816619828] 'agreement among raft nodes before linearized reading'  (duration: 133.795243ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T03:59:52.617484Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.661308ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697269736 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" mod_revision:578 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" value_size:22948 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-12T03:59:52.617721Z","caller":"traceutil/trace.go:171","msg":"trace[808014721] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"173.782943ms","start":"2026-09-12T03:59:52.443899Z","end":"2026-09-12T03:59:52.617682Z","steps":["trace[808014721] 'process raft request'  (duration: 49.139072ms)","trace[808014721] 'compare'  (duration: 123.536935ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T03:59:52.617993Z","caller":"traceutil/trace.go:171","msg":"trace[1860919136] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"129.513728ms","start":"2026-09-12T03:59:52.488455Z","end":"2026-09-12T03:59:52.617968Z","steps":["trace[1860919136] 'process raft request'  (duration: 129.464827ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T03:59:52.618063Z","caller":"traceutil/trace.go:171","msg":"trace[136778369] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"174.07946ms","start":"2026-09-12T03:59:52.443972Z","end":"2026-09-12T03:59:52.618052Z","steps":["trace[136778369] 'process raft request'  (duration: 173.63398ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T03:59:52.618159Z","caller":"traceutil/trace.go:171","msg":"trace[1555594481] transaction","detail":"{read_only:false; response_revision:584; number_of_response:1; }","duration":"136.71484ms","start":"2026-09-12T03:59:52.481434Z","end":"2026-09-12T03:59:52.618149Z","steps":["trace[1555594481] 'process raft request'  (duration: 136.324821ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T03:59:52.875493Z","caller":"traceutil/trace.go:171","msg":"trace[553066257] transaction","detail":"{read_only:false; response_revision:595; number_of_response:1; }","duration":"129.804425ms","start":"2026-09-12T03:59:52.745659Z","end":"2026-09-12T03:59:52.875463Z","steps":["trace[553066257] 'process raft request'  (duration: 116.470364ms)","trace[553066257] 'compare'  (duration: 12.87669ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T03:59:52.876387Z","caller":"traceutil/trace.go:171","msg":"trace[768915886] transaction","detail":"{read_only:false; response_revision:596; number_of_response:1; }","duration":"124.734523ms","start":"2026-09-12T03:59:52.751606Z","end":"2026-09-12T03:59:52.876341Z","steps":["trace[768915886] 'process raft request'  (duration: 124.502458ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T03:59:59.46805Z","caller":"traceutil/trace.go:171","msg":"trace[2010563381] transaction","detail":"{read_only:false; response_revision:656; number_of_response:1; }","duration":"239.466475ms","start":"2026-09-12T03:59:59.228556Z","end":"2026-09-12T03:59:59.468022Z","steps":["trace[2010563381] 'process raft request'  (duration: 238.785989ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:00:00.019398Z","caller":"traceutil/trace.go:171","msg":"trace[460911296] transaction","detail":"{read_only:false; response_revision:657; number_of_response:1; }","duration":"507.583215ms","start":"2026-09-12T03:59:59.511792Z","end":"2026-09-12T04:00:00.019375Z","steps":["trace[460911296] 'process raft request'  (duration: 507.338849ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:00:00.019719Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T03:59:59.511767Z","time spent":"507.722947ms","remote":"127.0.0.1:43072","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17126,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-zl4hl\" mod_revision:540 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-zl4hl\" value_size:17077 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-zl4hl\" > >"}
{"level":"info","ts":"2026-09-12T04:00:00.072302Z","caller":"traceutil/trace.go:171","msg":"trace[1885990878] linearizableReadLoop","detail":"{readStateIndex:680; appliedIndex:678; }","duration":"370.881934ms","start":"2026-09-12T03:59:59.701404Z","end":"2026-09-12T04:00:00.072285Z","steps":["trace[1885990878] 'read index received'  (duration: 317.768713ms)","trace[1885990878] 'applied index is now lower than readState.Index'  (duration: 53.112321ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:00:00.072421Z","caller":"traceutil/trace.go:171","msg":"trace[739400106] transaction","detail":"{read_only:false; response_revision:658; number_of_response:1; }","duration":"523.630962ms","start":"2026-09-12T03:59:59.548781Z","end":"2026-09-12T04:00:00.072412Z","steps":["trace[739400106] 'process raft request'  (duration: 523.423367ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:00:00.072478Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T03:59:59.548756Z","time spent":"523.686833ms","remote":"127.0.0.1:43138","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" mod_revision:0 > success:<request_put:<key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" value_size:2525 >> failure:<>"}
{"level":"warn","ts":"2026-09-12T04:00:00.07268Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"371.254063ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-12T04:00:00.072708Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"296.612744ms","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-09-12T04:00:00.072776Z","caller":"traceutil/trace.go:171","msg":"trace[1072476073] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:658; }","duration":"296.710296ms","start":"2026-09-12T03:59:59.776044Z","end":"2026-09-12T04:00:00.072754Z","steps":["trace[1072476073] 'agreement among raft nodes before linearized reading'  (duration: 296.444459ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:00:00.072778Z","caller":"traceutil/trace.go:171","msg":"trace[1371092301] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:658; }","duration":"371.406888ms","start":"2026-09-12T03:59:59.701344Z","end":"2026-09-12T04:00:00.072751Z","steps":["trace[1371092301] 'agreement among raft nodes before linearized reading'  (duration: 371.225773ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:00:00.072794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.033341ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"warn","ts":"2026-09-12T04:00:00.07282Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T03:59:59.701297Z","time spent":"371.51223ms","remote":"127.0.0.1:42856","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-09-12T04:00:00.072857Z","caller":"traceutil/trace.go:171","msg":"trace[1673117782] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:658; }","duration":"126.145094ms","start":"2026-09-12T03:59:59.946695Z","end":"2026-09-12T04:00:00.07284Z","steps":["trace[1673117782] 'agreement among raft nodes before linearized reading'  (duration: 125.962189ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:00:16.873061Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"255.573195ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697270203 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" mod_revision:762 > success:<request_put:<key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" value_size:3942 >> failure:<request_range:<key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-12T04:00:16.873212Z","caller":"traceutil/trace.go:171","msg":"trace[953223755] linearizableReadLoop","detail":"{readStateIndex:853; appliedIndex:852; }","duration":"171.970756ms","start":"2026-09-12T04:00:16.701218Z","end":"2026-09-12T04:00:16.873189Z","steps":["trace[953223755] 'read index received'  (duration: 61.012µs)","trace[953223755] 'applied index is now lower than readState.Index'  (duration: 171.905634ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:00:16.873281Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.066599ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:00:16.873305Z","caller":"traceutil/trace.go:171","msg":"trace[1158634065] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:826; }","duration":"172.130321ms","start":"2026-09-12T04:00:16.701165Z","end":"2026-09-12T04:00:16.873295Z","steps":["trace[1158634065] 'agreement among raft nodes before linearized reading'  (duration: 172.07591ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:00:16.873337Z","caller":"traceutil/trace.go:171","msg":"trace[1645714805] transaction","detail":"{read_only:false; response_revision:826; number_of_response:1; }","duration":"335.791042ms","start":"2026-09-12T04:00:16.537506Z","end":"2026-09-12T04:00:16.873297Z","steps":["trace[1645714805] 'process raft request'  (duration: 79.867236ms)","trace[1645714805] 'compare'  (duration: 255.36982ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:00:16.87405Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:00:16.537469Z","time spent":"336.528563ms","remote":"127.0.0.1:43072","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4026,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" mod_revision:762 > success:<request_put:<key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" value_size:3942 >> failure:<request_range:<key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-k2fkj\" > >"}
{"level":"info","ts":"2026-09-12T04:01:36.510301Z","caller":"traceutil/trace.go:171","msg":"trace[1201959137] linearizableReadLoop","detail":"{readStateIndex:1964; appliedIndex:1963; }","duration":"140.417315ms","start":"2026-09-12T04:01:36.369861Z","end":"2026-09-12T04:01:36.510278Z","steps":["trace[1201959137] 'read index received'  (duration: 140.27297ms)","trace[1201959137] 'applied index is now lower than readState.Index'  (duration: 143.455µs)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:01:36.51035Z","caller":"traceutil/trace.go:171","msg":"trace[1577015496] transaction","detail":"{read_only:false; response_revision:1893; number_of_response:1; }","duration":"141.520704ms","start":"2026-09-12T04:01:36.368793Z","end":"2026-09-12T04:01:36.510314Z","steps":["trace[1577015496] 'process raft request'  (duration: 141.357179ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:36.510461Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.585231ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:01:36.510529Z","caller":"traceutil/trace.go:171","msg":"trace[885007987] range","detail":"{range_begin:/registry/services/specs/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:1893; }","duration":"140.722716ms","start":"2026-09-12T04:01:36.369791Z","end":"2026-09-12T04:01:36.510514Z","steps":["trace[885007987] 'agreement among raft nodes before linearized reading'  (duration: 140.585891ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:36.85869Z","caller":"traceutil/trace.go:171","msg":"trace[1524060515] transaction","detail":"{read_only:false; response_revision:1898; number_of_response:1; }","duration":"122.564396ms","start":"2026-09-12T04:01:36.736074Z","end":"2026-09-12T04:01:36.858639Z","steps":["trace[1524060515] 'process raft request'  (duration: 116.083951ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:38.118331Z","caller":"traceutil/trace.go:171","msg":"trace[411662694] transaction","detail":"{read_only:false; response_revision:1908; number_of_response:1; }","duration":"163.378334ms","start":"2026-09-12T04:01:37.954927Z","end":"2026-09-12T04:01:38.118306Z","steps":["trace[411662694] 'process raft request'  (duration: 163.119445ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:38.442582Z","caller":"traceutil/trace.go:171","msg":"trace[933044223] transaction","detail":"{read_only:false; response_revision:1909; number_of_response:1; }","duration":"453.08231ms","start":"2026-09-12T04:01:37.989475Z","end":"2026-09-12T04:01:38.442557Z","steps":["trace[933044223] 'process raft request'  (duration: 378.900027ms)","trace[933044223] 'compare'  (duration: 74.014397ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:01:38.44281Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:37.989445Z","time spent":"453.268196ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:1886 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"info","ts":"2026-09-12T04:01:38.442883Z","caller":"traceutil/trace.go:171","msg":"trace[1524142430] transaction","detail":"{read_only:false; response_revision:1910; number_of_response:1; }","duration":"336.410779ms","start":"2026-09-12T04:01:38.106445Z","end":"2026-09-12T04:01:38.442856Z","steps":["trace[1524142430] 'process raft request'  (duration: 336.073587ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.443129Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.106419Z","time spent":"336.576784ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":474,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" mod_revision:1800 > success:<request_put:<key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" value_size:415 >> failure:<request_range:<key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" > >"}
{"level":"info","ts":"2026-09-12T04:01:38.443319Z","caller":"traceutil/trace.go:171","msg":"trace[1787437107] linearizableReadLoop","detail":"{readStateIndex:1981; appliedIndex:1979; }","duration":"441.283609ms","start":"2026-09-12T04:01:38.001489Z","end":"2026-09-12T04:01:38.442773Z","steps":["trace[1787437107] 'read index received'  (duration: 116.587517ms)","trace[1787437107] 'applied index is now lower than readState.Index'  (duration: 324.692582ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:01:38.443339Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"441.803748ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"}
{"level":"info","ts":"2026-09-12T04:01:38.443458Z","caller":"traceutil/trace.go:171","msg":"trace[451027627] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1910; }","duration":"442.025955ms","start":"2026-09-12T04:01:38.001412Z","end":"2026-09-12T04:01:38.443438Z","steps":["trace[451027627] 'agreement among raft nodes before linearized reading'  (duration: 441.633531ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.443561Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.001376Z","time spent":"442.16507ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"info","ts":"2026-09-12T04:01:38.653783Z","caller":"traceutil/trace.go:171","msg":"trace[460871820] transaction","detail":"{read_only:false; response_revision:1912; number_of_response:1; }","duration":"527.042104ms","start":"2026-09-12T04:01:38.126713Z","end":"2026-09-12T04:01:38.653755Z","steps":["trace[460871820] 'process raft request'  (duration: 526.94061ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:38.65377Z","caller":"traceutil/trace.go:171","msg":"trace[2039092858] transaction","detail":"{read_only:false; response_revision:1911; number_of_response:1; }","duration":"527.829011ms","start":"2026-09-12T04:01:38.125916Z","end":"2026-09-12T04:01:38.653745Z","steps":["trace[2039092858] 'process raft request'  (duration: 527.574452ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.654007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.12669Z","time spent":"527.197299ms","remote":"127.0.0.1:43156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1530,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-5hlp9\" mod_revision:1876 > success:<request_put:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-5hlp9\" value_size:1459 >> failure:<request_range:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-5hlp9\" > >"}
{"level":"warn","ts":"2026-09-12T04:01:38.654214Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.125893Z","time spent":"528.022007ms","remote":"127.0.0.1:43156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1472,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-nfdgg\" mod_revision:1881 > success:<request_put:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-nfdgg\" value_size:1392 >> failure:<request_range:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-nfdgg\" > >"}
{"level":"info","ts":"2026-09-12T04:01:38.654615Z","caller":"traceutil/trace.go:171","msg":"trace[1364545222] linearizableReadLoop","detail":"{readStateIndex:1986; appliedIndex:1982; }","duration":"211.231661ms","start":"2026-09-12T04:01:38.443369Z","end":"2026-09-12T04:01:38.6546Z","steps":["trace[1364545222] 'read index received'  (duration: 210.148904ms)","trace[1364545222] 'applied index is now lower than readState.Index'  (duration: 1.081857ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:01:38.654774Z","caller":"traceutil/trace.go:171","msg":"trace[1765917601] transaction","detail":"{read_only:false; response_revision:1913; number_of_response:1; }","duration":"527.686307ms","start":"2026-09-12T04:01:38.127065Z","end":"2026-09-12T04:01:38.654752Z","steps":["trace[1765917601] 'process raft request'  (duration: 526.62891ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.654833Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"303.444371ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-09-12T04:01:38.654868Z","caller":"traceutil/trace.go:171","msg":"trace[186265869] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1914; }","duration":"303.529884ms","start":"2026-09-12T04:01:38.351328Z","end":"2026-09-12T04:01:38.654857Z","steps":["trace[186265869] 'agreement among raft nodes before linearized reading'  (duration: 303.352998ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.654898Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.3513Z","time spent":"303.591806ms","remote":"127.0.0.1:50308","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5467,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "}
{"level":"warn","ts":"2026-09-12T04:01:38.65494Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.127046Z","time spent":"527.80579ms","remote":"127.0.0.1:43058","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":894,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" mod_revision:1880 > success:<request_put:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" value_size:816 >> failure:<request_range:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" > >"}
{"level":"warn","ts":"2026-09-12T04:01:38.655123Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"645.511147ms","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-09-12T04:01:38.65519Z","caller":"traceutil/trace.go:171","msg":"trace[129079581] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:1914; }","duration":"645.625411ms","start":"2026-09-12T04:01:38.009547Z","end":"2026-09-12T04:01:38.655172Z","steps":["trace[129079581] 'agreement among raft nodes before linearized reading'  (duration: 645.515227ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.655243Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.009469Z","time spent":"645.753946ms","remote":"127.0.0.1:42918","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true "}
{"level":"warn","ts":"2026-09-12T04:01:38.655242Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"530.64529ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-3e977ad2-0e8e-4fe0-8905-fb53812dbeb3\" ","response":"range_response_count:1 size:3625"}
{"level":"info","ts":"2026-09-12T04:01:38.655333Z","caller":"traceutil/trace.go:171","msg":"trace[1937187369] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-3e977ad2-0e8e-4fe0-8905-fb53812dbeb3; range_end:; response_count:1; response_revision:1914; }","duration":"530.801305ms","start":"2026-09-12T04:01:38.124509Z","end":"2026-09-12T04:01:38.655311Z","steps":["trace[1937187369] 'agreement among raft nodes before linearized reading'  (duration: 530.542516ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.655395Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.124485Z","time spent":"530.899699ms","remote":"127.0.0.1:43072","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3648,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-3e977ad2-0e8e-4fe0-8905-fb53812dbeb3\" "}
{"level":"warn","ts":"2026-09-12T04:01:38.656049Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"558.883712ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-controller\" ","response":"range_response_count:1 size:528"}
{"level":"info","ts":"2026-09-12T04:01:38.656189Z","caller":"traceutil/trace.go:171","msg":"trace[889350245] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-controller; range_end:; response_count:1; response_revision:1914; }","duration":"559.055209ms","start":"2026-09-12T04:01:38.097121Z","end":"2026-09-12T04:01:38.656176Z","steps":["trace[889350245] 'agreement among raft nodes before linearized reading'  (duration: 557.592767ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.656263Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.097095Z","time spent":"559.116751ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":55,"response count":1,"response size":551,"request content":"key:\"/registry/leases/cert-manager/cert-manager-controller\" "}
{"level":"info","ts":"2026-09-12T04:01:38.657942Z","caller":"traceutil/trace.go:171","msg":"trace[850427034] transaction","detail":"{read_only:false; response_revision:1915; number_of_response:1; }","duration":"209.345386ms","start":"2026-09-12T04:01:38.448578Z","end":"2026-09-12T04:01:38.657924Z","steps":["trace[850427034] 'process raft request'  (duration: 209.143899ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:38.658466Z","caller":"traceutil/trace.go:171","msg":"trace[931861882] transaction","detail":"{read_only:false; response_revision:1914; number_of_response:1; }","duration":"527.152838ms","start":"2026-09-12T04:01:38.127493Z","end":"2026-09-12T04:01:38.654646Z","steps":["trace[931861882] 'process raft request'  (duration: 526.995053ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:01:38.658617Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:01:38.127484Z","time spent":"531.057063ms","remote":"127.0.0.1:43058","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":978,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" mod_revision:1877 > success:<request_put:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" value_size:909 >> failure:<request_range:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" > >"}
{"level":"info","ts":"2026-09-12T04:01:38.791075Z","caller":"traceutil/trace.go:171","msg":"trace[1813464513] transaction","detail":"{read_only:false; response_revision:1917; number_of_response:1; }","duration":"127.385614ms","start":"2026-09-12T04:01:38.663641Z","end":"2026-09-12T04:01:38.791027Z","steps":["trace[1813464513] 'process raft request'  (duration: 121.569202ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:38.798437Z","caller":"traceutil/trace.go:171","msg":"trace[1549291323] transaction","detail":"{read_only:false; response_revision:1918; number_of_response:1; }","duration":"132.14114ms","start":"2026-09-12T04:01:38.666275Z","end":"2026-09-12T04:01:38.798416Z","steps":["trace[1549291323] 'process raft request'  (duration: 131.996835ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:01:51.105376Z","caller":"traceutil/trace.go:171","msg":"trace[1568292735] transaction","detail":"{read_only:false; response_revision:2021; number_of_response:1; }","duration":"144.703621ms","start":"2026-09-12T04:01:50.960648Z","end":"2026-09-12T04:01:51.105352Z","steps":["trace[1568292735] 'process raft request'  (duration: 123.907098ms)","trace[1568292735] 'compare'  (duration: 20.655928ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:01:51.105749Z","caller":"traceutil/trace.go:171","msg":"trace[1183185757] transaction","detail":"{read_only:false; response_revision:2022; number_of_response:1; }","duration":"128.054636ms","start":"2026-09-12T04:01:50.977669Z","end":"2026-09-12T04:01:51.105724Z","steps":["trace[1183185757] 'process raft request'  (duration: 127.648761ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:27.147505Z","caller":"traceutil/trace.go:171","msg":"trace[1798720731] transaction","detail":"{read_only:false; response_revision:2228; number_of_response:1; }","duration":"111.082705ms","start":"2026-09-12T04:02:27.036364Z","end":"2026-09-12T04:02:27.147446Z","steps":["trace[1798720731] 'process raft request'  (duration: 110.145891ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:27.574607Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.477248ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697273146 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2220 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-12T04:02:27.574803Z","caller":"traceutil/trace.go:171","msg":"trace[1678883286] transaction","detail":"{read_only:false; response_revision:2231; number_of_response:1; }","duration":"322.744355ms","start":"2026-09-12T04:02:27.252036Z","end":"2026-09-12T04:02:27.574781Z","steps":["trace[1678883286] 'process raft request'  (duration: 119.999027ms)","trace[1678883286] 'compare'  (duration: 202.310703ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:02:27.574879Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.252008Z","time spent":"322.837478ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2220 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-09-12T04:02:27.575096Z","caller":"traceutil/trace.go:171","msg":"trace[1935982501] transaction","detail":"{read_only:false; response_revision:2232; number_of_response:1; }","duration":"315.132061ms","start":"2026-09-12T04:02:27.25993Z","end":"2026-09-12T04:02:27.575062Z","steps":["trace[1935982501] 'process raft request'  (duration: 314.787288ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:27.575164Z","caller":"traceutil/trace.go:171","msg":"trace[1563052222] linearizableReadLoop","detail":"{readStateIndex:2316; appliedIndex:2314; }","duration":"289.797975ms","start":"2026-09-12T04:02:27.285214Z","end":"2026-09-12T04:02:27.575012Z","steps":["trace[1563052222] 'read index received'  (duration: 86.812128ms)","trace[1563052222] 'applied index is now lower than readState.Index'  (duration: 202.982797ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:02:27.575266Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.259916Z","time spent":"315.258235ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2221 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"warn","ts":"2026-09-12T04:02:27.57537Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"290.151587ms","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-09-12T04:02:27.575411Z","caller":"traceutil/trace.go:171","msg":"trace[1883724819] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2232; }","duration":"290.192859ms","start":"2026-09-12T04:02:27.285207Z","end":"2026-09-12T04:02:27.5754Z","steps":["trace[1883724819] 'agreement among raft nodes before linearized reading'  (duration: 290.055554ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:27.575534Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.78259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-09-12T04:02:27.575591Z","caller":"traceutil/trace.go:171","msg":"trace[1778619260] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2232; }","duration":"272.891674ms","start":"2026-09-12T04:02:27.302684Z","end":"2026-09-12T04:02:27.575576Z","steps":["trace[1778619260] 'agreement among raft nodes before linearized reading'  (duration: 272.613284ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:28.146706Z","caller":"traceutil/trace.go:171","msg":"trace[252962635] transaction","detail":"{read_only:false; response_revision:2233; number_of_response:1; }","duration":"567.207835ms","start":"2026-09-12T04:02:27.579457Z","end":"2026-09-12T04:02:28.146665Z","steps":["trace[252962635] 'process raft request'  (duration: 539.521783ms)","trace[252962635] 'compare'  (duration: 27.571378ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:02:28.146994Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.579416Z","time spent":"567.477294ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:2222 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-09-12T04:02:28.201459Z","caller":"traceutil/trace.go:171","msg":"trace[119075578] linearizableReadLoop","detail":"{readStateIndex:2318; appliedIndex:2316; }","duration":"500.263126ms","start":"2026-09-12T04:02:27.701122Z","end":"2026-09-12T04:02:28.201385Z","steps":["trace[119075578] 'read index received'  (duration: 417.871066ms)","trace[119075578] 'applied index is now lower than readState.Index'  (duration: 82.39098ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:28.201581Z","caller":"traceutil/trace.go:171","msg":"trace[897250135] transaction","detail":"{read_only:false; response_revision:2234; number_of_response:1; }","duration":"621.794469ms","start":"2026-09-12T04:02:27.579747Z","end":"2026-09-12T04:02:28.201541Z","steps":["trace[897250135] 'process raft request'  (duration: 621.496677ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:28.20169Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"351.764138ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"warn","ts":"2026-09-12T04:02:28.201695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"500.528515ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:02:28.201735Z","caller":"traceutil/trace.go:171","msg":"trace[1736137199] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:2234; }","duration":"351.874462ms","start":"2026-09-12T04:02:27.849848Z","end":"2026-09-12T04:02:28.201722Z","steps":["trace[1736137199] 'agreement among raft nodes before linearized reading'  (duration: 351.764438ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:28.201775Z","caller":"traceutil/trace.go:171","msg":"trace[1626494149] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2234; }","duration":"500.66956ms","start":"2026-09-12T04:02:27.701082Z","end":"2026-09-12T04:02:28.201752Z","steps":["trace[1626494149] 'agreement among raft nodes before linearized reading'  (duration: 500.507824ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:28.201777Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.84979Z","time spent":"351.976846ms","remote":"127.0.0.1:43264","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":30,"request content":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true "}
{"level":"warn","ts":"2026-09-12T04:02:28.201841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.579727Z","time spent":"621.950574ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:2223 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-09-12T04:02:28.20186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:02:27.701064Z","time spent":"500.782614ms","remote":"127.0.0.1:42850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"warn","ts":"2026-09-12T04:02:28.201864Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.435176ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/acme.cert-manager.io/challenges/\" range_end:\"/registry/acme.cert-manager.io/challenges0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:02:28.20195Z","caller":"traceutil/trace.go:171","msg":"trace[2133170462] range","detail":"{range_begin:/registry/acme.cert-manager.io/challenges/; range_end:/registry/acme.cert-manager.io/challenges0; response_count:0; response_revision:2234; }","duration":"125.530839ms","start":"2026-09-12T04:02:28.076394Z","end":"2026-09-12T04:02:28.201924Z","steps":["trace[2133170462] 'agreement among raft nodes before linearized reading'  (duration: 125.300761ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:28.202005Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.581823ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-09-12T04:02:28.202066Z","caller":"traceutil/trace.go:171","msg":"trace[649570915] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2234; }","duration":"195.700046ms","start":"2026-09-12T04:02:28.006347Z","end":"2026-09-12T04:02:28.202047Z","steps":["trace[649570915] 'agreement among raft nodes before linearized reading'  (duration: 195.388085ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:54.308237Z","caller":"traceutil/trace.go:171","msg":"trace[1054195332] transaction","detail":"{read_only:false; response_revision:2389; number_of_response:1; }","duration":"115.171658ms","start":"2026-09-12T04:02:54.19304Z","end":"2026-09-12T04:02:54.308211Z","steps":["trace[1054195332] 'process raft request'  (duration: 114.542435ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:54.590356Z","caller":"traceutil/trace.go:171","msg":"trace[1263936393] transaction","detail":"{read_only:false; response_revision:2393; number_of_response:1; }","duration":"136.042251ms","start":"2026-09-12T04:02:54.454285Z","end":"2026-09-12T04:02:54.590327Z","steps":["trace[1263936393] 'process raft request'  (duration: 99.162014ms)","trace[1263936393] 'compare'  (duration: 36.733132ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:55.052903Z","caller":"traceutil/trace.go:171","msg":"trace[106175777] transaction","detail":"{read_only:false; response_revision:2396; number_of_response:1; }","duration":"120.936911ms","start":"2026-09-12T04:02:54.931938Z","end":"2026-09-12T04:02:55.052875Z","steps":["trace[106175777] 'process raft request'  (duration: 108.667802ms)","trace[106175777] 'compare'  (duration: 12.046031ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:55.345905Z","caller":"traceutil/trace.go:171","msg":"trace[930354200] linearizableReadLoop","detail":"{readStateIndex:2487; appliedIndex:2486; }","duration":"117.907951ms","start":"2026-09-12T04:02:55.227979Z","end":"2026-09-12T04:02:55.345887Z","steps":["trace[930354200] 'read index received'  (duration: 117.578198ms)","trace[930354200] 'applied index is now lower than readState.Index'  (duration: 328.753µs)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:55.345974Z","caller":"traceutil/trace.go:171","msg":"trace[2066922142] transaction","detail":"{read_only:false; response_revision:2398; number_of_response:1; }","duration":"150.345126ms","start":"2026-09-12T04:02:55.1956Z","end":"2026-09-12T04:02:55.345945Z","steps":["trace[2066922142] 'process raft request'  (duration: 150.046264ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:55.346092Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.079697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/superstreams/\" range_end:\"/registry/rabbitmq.com/superstreams0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:02:55.34616Z","caller":"traceutil/trace.go:171","msg":"trace[600307894] range","detail":"{range_begin:/registry/rabbitmq.com/superstreams/; range_end:/registry/rabbitmq.com/superstreams0; response_count:0; response_revision:2398; }","duration":"118.190251ms","start":"2026-09-12T04:02:55.227952Z","end":"2026-09-12T04:02:55.346142Z","steps":["trace[600307894] 'agreement among raft nodes before linearized reading'  (duration: 118.012825ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:55.497646Z","caller":"traceutil/trace.go:171","msg":"trace[1494731376] transaction","detail":"{read_only:false; response_revision:2400; number_of_response:1; }","duration":"122.975005ms","start":"2026-09-12T04:02:55.374647Z","end":"2026-09-12T04:02:55.497622Z","steps":["trace[1494731376] 'process raft request'  (duration: 79.950482ms)","trace[1494731376] 'compare'  (duration: 42.898759ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:55.524631Z","caller":"traceutil/trace.go:171","msg":"trace[439941645] linearizableReadLoop","detail":"{readStateIndex:2490; appliedIndex:2488; }","duration":"131.180585ms","start":"2026-09-12T04:02:55.393427Z","end":"2026-09-12T04:02:55.524607Z","steps":["trace[439941645] 'read index received'  (duration: 61.200626ms)","trace[439941645] 'applied index is now lower than readState.Index'  (duration: 69.978759ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:55.52489Z","caller":"traceutil/trace.go:171","msg":"trace[553958373] transaction","detail":"{read_only:false; response_revision:2401; number_of_response:1; }","duration":"147.559444ms","start":"2026-09-12T04:02:55.377152Z","end":"2026-09-12T04:02:55.524711Z","steps":["trace[553958373] 'process raft request'  (duration: 147.353076ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:55.524962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.492166ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"}
{"level":"warn","ts":"2026-09-12T04:02:55.524972Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.186306ms","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-09-12T04:02:55.525023Z","caller":"traceutil/trace.go:171","msg":"trace[1516107834] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2401; }","duration":"131.596231ms","start":"2026-09-12T04:02:55.393393Z","end":"2026-09-12T04:02:55.524989Z","steps":["trace[1516107834] 'agreement among raft nodes before linearized reading'  (duration: 131.348142ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:55.525041Z","caller":"traceutil/trace.go:171","msg":"trace[1248652227] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2401; }","duration":"122.296091ms","start":"2026-09-12T04:02:55.402728Z","end":"2026-09-12T04:02:55.525024Z","steps":["trace[1248652227] 'agreement among raft nodes before linearized reading'  (duration: 122.078533ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:57.989236Z","caller":"traceutil/trace.go:171","msg":"trace[869647574] transaction","detail":"{read_only:false; response_revision:2426; number_of_response:1; }","duration":"141.952162ms","start":"2026-09-12T04:02:57.847248Z","end":"2026-09-12T04:02:57.9892Z","steps":["trace[869647574] 'process raft request'  (duration: 111.107695ms)","trace[869647574] 'compare'  (duration: 30.129991ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:57.996092Z","caller":"traceutil/trace.go:171","msg":"trace[1884045886] linearizableReadLoop","detail":"{readStateIndex:2518; appliedIndex:2516; }","duration":"101.091827ms","start":"2026-09-12T04:02:57.894976Z","end":"2026-09-12T04:02:57.996068Z","steps":["trace[1884045886] 'read index received'  (duration: 63.206402ms)","trace[1884045886] 'applied index is now lower than readState.Index'  (duration: 37.884445ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:57.996117Z","caller":"traceutil/trace.go:171","msg":"trace[1886372162] transaction","detail":"{read_only:false; response_revision:2427; number_of_response:1; }","duration":"103.594019ms","start":"2026-09-12T04:02:57.892492Z","end":"2026-09-12T04:02:57.996086Z","steps":["trace[1886372162] 'process raft request'  (duration: 103.387592ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:02:57.996271Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.266183ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/openstack/\" range_end:\"/registry/limitranges/openstack0\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:02:57.99631Z","caller":"traceutil/trace.go:171","msg":"trace[1118156609] range","detail":"{range_begin:/registry/limitranges/openstack/; range_end:/registry/limitranges/openstack0; response_count:0; response_revision:2428; }","duration":"101.353997ms","start":"2026-09-12T04:02:57.894941Z","end":"2026-09-12T04:02:57.996295Z","steps":["trace[1118156609] 'agreement among raft nodes before linearized reading'  (duration: 101.219002ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:57.996449Z","caller":"traceutil/trace.go:171","msg":"trace[61151208] transaction","detail":"{read_only:false; response_revision:2428; number_of_response:1; }","duration":"100.749135ms","start":"2026-09-12T04:02:57.895628Z","end":"2026-09-12T04:02:57.996377Z","steps":["trace[61151208] 'process raft request'  (duration: 100.391942ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:02:58.243328Z","caller":"traceutil/trace.go:171","msg":"trace[593140844] transaction","detail":"{read_only:false; response_revision:2436; number_of_response:1; }","duration":"102.586754ms","start":"2026-09-12T04:02:58.140709Z","end":"2026-09-12T04:02:58.243295Z","steps":["trace[593140844] 'process raft request'  (duration: 89.408302ms)","trace[593140844] 'compare'  (duration: 13.040107ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:02:58.295179Z","caller":"traceutil/trace.go:171","msg":"trace[2143359716] transaction","detail":"{read_only:false; response_revision:2437; number_of_response:1; }","duration":"101.653589ms","start":"2026-09-12T04:02:58.193492Z","end":"2026-09-12T04:02:58.295145Z","steps":["trace[2143359716] 'process raft request'  (duration: 100.59761ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:03:12.706927Z","caller":"traceutil/trace.go:171","msg":"trace[1672819471] linearizableReadLoop","detail":"{readStateIndex:2672; appliedIndex:2671; }","duration":"154.618298ms","start":"2026-09-12T04:03:12.552269Z","end":"2026-09-12T04:03:12.706887Z","steps":["trace[1672819471] 'read index received'  (duration: 154.412201ms)","trace[1672819471] 'applied index is now lower than readState.Index'  (duration: 205.067µs)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:03:12.707195Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.89499ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-09-12T04:03:12.707297Z","caller":"traceutil/trace.go:171","msg":"trace[1973643500] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2578; }","duration":"155.061345ms","start":"2026-09-12T04:03:12.552218Z","end":"2026-09-12T04:03:12.70728Z","steps":["trace[1973643500] 'agreement among raft nodes before linearized reading'  (duration: 154.821056ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:03:12.707578Z","caller":"traceutil/trace.go:171","msg":"trace[1756022908] transaction","detail":"{read_only:false; response_revision:2578; number_of_response:1; }","duration":"194.576916ms","start":"2026-09-12T04:03:12.512433Z","end":"2026-09-12T04:03:12.70701Z","steps":["trace[1756022908] 'process raft request'  (duration: 194.275586ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.157424Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":1859318777697274456,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-09-12T04:03:47.439135Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"262.457093ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697274462 > lease_revoke:<id:19cda093c4dc0972>","response":"size:28"}
{"level":"info","ts":"2026-09-12T04:03:47.465221Z","caller":"traceutil/trace.go:171","msg":"trace[1707572533] transaction","detail":"{read_only:false; response_revision:2766; number_of_response:1; }","duration":"463.697873ms","start":"2026-09-12T04:03:47.00151Z","end":"2026-09-12T04:03:47.465208Z","steps":["trace[1707572533] 'process raft request'  (duration: 463.489765ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.465445Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.001487Z","time spent":"463.823748ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:2756 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-09-12T04:03:47.465727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"809.197275ms","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-09-12T04:03:47.465848Z","caller":"traceutil/trace.go:171","msg":"trace[732277566] range","detail":"{range_begin:/registry/services/specs/auth-system/keycloak-headless; range_end:; response_count:1; response_revision:2766; }","duration":"809.36936ms","start":"2026-09-12T04:03:46.656457Z","end":"2026-09-12T04:03:47.465827Z","steps":["trace[732277566] 'agreement among raft nodes before linearized reading'  (duration: 808.931825ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.465905Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:46.656436Z","time spent":"809.460324ms","remote":"127.0.0.1:43086","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":1,"response size":1392,"request content":"key:\"/registry/services/specs/auth-system/keycloak-headless\" "}
{"level":"info","ts":"2026-09-12T04:03:47.46577Z","caller":"traceutil/trace.go:171","msg":"trace[833176499] linearizableReadLoop","detail":"{readStateIndex:2868; appliedIndex:2866; }","duration":"808.640183ms","start":"2026-09-12T04:03:46.656513Z","end":"2026-09-12T04:03:47.465153Z","steps":["trace[833176499] 'read index received'  (duration: 520.183899ms)","trace[833176499] 'applied index is now lower than readState.Index'  (duration: 288.455574ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:03:47.466531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.536646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"}
{"level":"info","ts":"2026-09-12T04:03:47.466566Z","caller":"traceutil/trace.go:171","msg":"trace[1152688352] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2766; }","duration":"113.608881ms","start":"2026-09-12T04:03:47.352949Z","end":"2026-09-12T04:03:47.466558Z","steps":["trace[1152688352] 'agreement among raft nodes before linearized reading'  (duration: 113.497947ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.466917Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"550.842724ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-09-12T04:03:47.466998Z","caller":"traceutil/trace.go:171","msg":"trace[1733577708] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2766; }","duration":"550.95564ms","start":"2026-09-12T04:03:46.916021Z","end":"2026-09-12T04:03:47.466976Z","steps":["trace[1733577708] 'agreement among raft nodes before linearized reading'  (duration: 550.784702ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.467032Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:46.915992Z","time spent":"551.032162ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":578,"request content":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" "}
{"level":"warn","ts":"2026-09-12T04:03:47.467361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"578.59323ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"info","ts":"2026-09-12T04:03:47.467704Z","caller":"traceutil/trace.go:171","msg":"trace[971098799] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2766; }","duration":"579.598397ms","start":"2026-09-12T04:03:46.88798Z","end":"2026-09-12T04:03:47.467579Z","steps":["trace[971098799] 'agreement among raft nodes before linearized reading'  (duration: 578.458905ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:47.46793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:46.887932Z","time spent":"579.899359ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-09-12T04:03:48.103801Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"399.347994ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697274468 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:2754 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-12T04:03:48.103995Z","caller":"traceutil/trace.go:171","msg":"trace[64415925] linearizableReadLoop","detail":"{readStateIndex:2871; appliedIndex:2869; }","duration":"596.717241ms","start":"2026-09-12T04:03:47.507262Z","end":"2026-09-12T04:03:48.103979Z","steps":["trace[64415925] 'read index received'  (duration: 197.002703ms)","trace[64415925] 'applied index is now lower than readState.Index'  (duration: 399.713758ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:03:48.104066Z","caller":"traceutil/trace.go:171","msg":"trace[1161229480] transaction","detail":"{read_only:false; response_revision:2768; number_of_response:1; }","duration":"629.120649ms","start":"2026-09-12T04:03:47.474936Z","end":"2026-09-12T04:03:48.104056Z","steps":["trace[1161229480] 'process raft request'  (duration: 229.386891ms)","trace[1161229480] 'compare'  (duration: 399.175957ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:03:48.104114Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.474927Z","time spent":"629.163191ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:2754 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-09-12T04:03:48.104258Z","caller":"traceutil/trace.go:171","msg":"trace[1463563613] transaction","detail":"{read_only:false; response_revision:2769; number_of_response:1; }","duration":"625.92238ms","start":"2026-09-12T04:03:47.478298Z","end":"2026-09-12T04:03:48.104221Z","steps":["trace[1463563613] 'process raft request'  (duration: 625.602039ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.10443Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.478269Z","time spent":"626.060385ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:2755 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-09-12T04:03:48.104535Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"597.228189ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/auth-system/keycloak\" ","response":"range_response_count:1 size:7462"}
{"level":"info","ts":"2026-09-12T04:03:48.104622Z","caller":"traceutil/trace.go:171","msg":"trace[1290044932] range","detail":"{range_begin:/registry/statefulsets/auth-system/keycloak; range_end:; response_count:1; response_revision:2769; }","duration":"597.389596ms","start":"2026-09-12T04:03:47.50721Z","end":"2026-09-12T04:03:48.104599Z","steps":["trace[1290044932] 'agreement among raft nodes before linearized reading'  (duration: 597.034482ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.104669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.507165Z","time spent":"597.48246ms","remote":"127.0.0.1:43336","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":7485,"request content":"key:\"/registry/statefulsets/auth-system/keycloak\" "}
{"level":"warn","ts":"2026-09-12T04:03:48.551185Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.220562ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697274471 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2762 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-12T04:03:48.551287Z","caller":"traceutil/trace.go:171","msg":"trace[1487499696] linearizableReadLoop","detail":"{readStateIndex:2872; appliedIndex:2871; }","duration":"447.251217ms","start":"2026-09-12T04:03:48.10402Z","end":"2026-09-12T04:03:48.551271Z","steps":["trace[1487499696] 'read index received'  (duration: 249.940902ms)","trace[1487499696] 'applied index is now lower than readState.Index'  (duration: 197.309395ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:03:48.551335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"850.89602ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:03:48.551547Z","caller":"traceutil/trace.go:171","msg":"trace[2026708547] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2770; }","duration":"851.153909ms","start":"2026-09-12T04:03:47.700382Z","end":"2026-09-12T04:03:48.551536Z","steps":["trace[2026708547] 'agreement among raft nodes before linearized reading'  (duration: 850.925041ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:03:48.551516Z","caller":"traceutil/trace.go:171","msg":"trace[2075117070] transaction","detail":"{read_only:false; response_revision:2770; number_of_response:1; }","duration":"524.217343ms","start":"2026-09-12T04:03:48.027264Z","end":"2026-09-12T04:03:48.551481Z","steps":["trace[2075117070] 'process raft request'  (duration: 326.613507ms)","trace[2075117070] 'compare'  (duration: 197.086587ms)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:03:48.551623Z","caller":"traceutil/trace.go:171","msg":"trace[1637316465] transaction","detail":"{read_only:false; response_revision:2771; number_of_response:1; }","duration":"415.124859ms","start":"2026-09-12T04:03:48.136468Z","end":"2026-09-12T04:03:48.551593Z","steps":["trace[1637316465] 'process raft request'  (duration: 414.899471ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.551707Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"647.2257ms","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":"warn","ts":"2026-09-12T04:03:48.551747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"631.309103ms","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-09-12T04:03:48.551758Z","caller":"traceutil/trace.go:171","msg":"trace[1360158689] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:2771; }","duration":"647.323064ms","start":"2026-09-12T04:03:47.904428Z","end":"2026-09-12T04:03:48.551751Z","steps":["trace[1360158689] 'agreement among raft nodes before linearized reading'  (duration: 647.177038ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.551785Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.904387Z","time spent":"647.391267ms","remote":"127.0.0.1:43144","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":0,"response size":28,"request content":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true "}
{"level":"warn","ts":"2026-09-12T04:03:48.551815Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:48.136446Z","time spent":"415.261294ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2765 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-09-12T04:03:48.551784Z","caller":"traceutil/trace.go:171","msg":"trace[925163399] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2771; }","duration":"631.379906ms","start":"2026-09-12T04:03:47.920389Z","end":"2026-09-12T04:03:48.551769Z","steps":["trace[925163399] 'agreement among raft nodes before linearized reading'  (duration: 631.220569ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.551927Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.920369Z","time spent":"631.548041ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-09-12T04:03:48.551561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"635.32212ms","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-09-12T04:03:48.552005Z","caller":"traceutil/trace.go:171","msg":"trace[1505678050] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2770; }","duration":"635.802698ms","start":"2026-09-12T04:03:47.916192Z","end":"2026-09-12T04:03:48.551995Z","steps":["trace[1505678050] 'agreement among raft nodes before linearized reading'  (duration: 635.249427ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.552039Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.916179Z","time spent":"635.8508ms","remote":"127.0.0.1:43150","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-09-12T04:03:48.551561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"642.784786ms","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-09-12T04:03:48.55208Z","caller":"traceutil/trace.go:171","msg":"trace[1870883297] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2770; }","duration":"643.342207ms","start":"2026-09-12T04:03:47.90873Z","end":"2026-09-12T04:03:48.552073Z","steps":["trace[1870883297] 'agreement among raft nodes before linearized reading'  (duration: 642.746595ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:03:48.552106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.90871Z","time spent":"643.389069ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-09-12T04:03:48.551771Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:48.027226Z","time spent":"524.407619ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2762 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"warn","ts":"2026-09-12T04:03:48.551587Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:03:47.700361Z","time spent":"851.216861ms","remote":"127.0.0.1:42850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-09-12T04:03:48.554856Z","caller":"traceutil/trace.go:171","msg":"trace[716918515] transaction","detail":"{read_only:false; response_revision:2772; number_of_response:1; }","duration":"177.333457ms","start":"2026-09-12T04:03:48.377506Z","end":"2026-09-12T04:03:48.554839Z","steps":["trace[716918515] 'process raft request'  (duration: 176.858369ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:04:43.023292Z","caller":"traceutil/trace.go:171","msg":"trace[1676911447] transaction","detail":"{read_only:false; response_revision:3062; number_of_response:1; }","duration":"101.56571ms","start":"2026-09-12T04:04:42.921702Z","end":"2026-09-12T04:04:43.023267Z","steps":["trace[1676911447] 'process raft request'  (duration: 89.581069ms)","trace[1676911447] 'compare'  (duration: 11.872818ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:07:57.049372Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.572111ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus\" ","response":"range_response_count:1 size:3506"}
{"level":"info","ts":"2026-09-12T04:07:57.049559Z","caller":"traceutil/trace.go:171","msg":"trace[1012566012] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus; range_end:; response_count:1; response_revision:4767; }","duration":"121.812558ms","start":"2026-09-12T04:07:56.927716Z","end":"2026-09-12T04:07:57.049528Z","steps":["trace[1012566012] 'range keys from in-memory index tree'  (duration: 121.355074ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:08:03.812803Z","caller":"traceutil/trace.go:171","msg":"trace[1524714156] linearizableReadLoop","detail":"{readStateIndex:5003; appliedIndex:5002; }","duration":"250.452219ms","start":"2026-09-12T04:08:03.562331Z","end":"2026-09-12T04:08:03.812783Z","steps":["trace[1524714156] 'read index received'  (duration: 250.298805ms)","trace[1524714156] 'applied index is now lower than readState.Index'  (duration: 152.594µs)"],"step_count":2}
{"level":"info","ts":"2026-09-12T04:08:03.813186Z","caller":"traceutil/trace.go:171","msg":"trace[989186391] transaction","detail":"{read_only:false; response_revision:4822; number_of_response:1; }","duration":"250.947694ms","start":"2026-09-12T04:08:03.562212Z","end":"2026-09-12T04:08:03.813159Z","steps":["trace[989186391] 'process raft request'  (duration: 250.431738ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:08:03.813368Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.020566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-09-12T04:08:03.813393Z","caller":"traceutil/trace.go:171","msg":"trace[1035324399] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:4822; }","duration":"251.095488ms","start":"2026-09-12T04:08:03.562289Z","end":"2026-09-12T04:08:03.813385Z","steps":["trace[1035324399] 'agreement among raft nodes before linearized reading'  (duration: 251.029816ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:08:03.813635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.081201ms","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-09-12T04:08:03.813652Z","caller":"traceutil/trace.go:171","msg":"trace[1162084050] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:4822; }","duration":"241.119893ms","start":"2026-09-12T04:08:03.572528Z","end":"2026-09-12T04:08:03.813648Z","steps":["trace[1162084050] 'agreement among raft nodes before linearized reading'  (duration: 241.040081ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:08:03.813844Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.083794ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-12T04:08:03.813863Z","caller":"traceutil/trace.go:171","msg":"trace[1976761405] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4822; }","duration":"113.122066ms","start":"2026-09-12T04:08:03.700735Z","end":"2026-09-12T04:08:03.813857Z","steps":["trace[1976761405] 'agreement among raft nodes before linearized reading'  (duration: 113.042274ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:08:16.506988Z","caller":"traceutil/trace.go:171","msg":"trace[273523338] transaction","detail":"{read_only:false; response_revision:5056; number_of_response:1; }","duration":"102.80075ms","start":"2026-09-12T04:08:16.404162Z","end":"2026-09-12T04:08:16.506962Z","steps":["trace[273523338] 'process raft request'  (duration: 102.642486ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:08:16.645237Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.226612ms","expected-duration":"100ms","prefix":"","request":"header:<ID:1859318777697280168 > lease_revoke:<id:19cda093c4dc1e2c>","response":"size:28"}
{"level":"info","ts":"2026-09-12T04:08:16.645472Z","caller":"traceutil/trace.go:171","msg":"trace[39694791] linearizableReadLoop","detail":"{readStateIndex:5244; appliedIndex:5242; }","duration":"118.049159ms","start":"2026-09-12T04:08:16.527406Z","end":"2026-09-12T04:08:16.645455Z","steps":["trace[39694791] 'read index received'  (duration: 10.563038ms)","trace[39694791] 'applied index is now lower than readState.Index'  (duration: 107.485251ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-12T04:08:16.645561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.150483ms","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-09-12T04:08:16.645616Z","caller":"traceutil/trace.go:171","msg":"trace[63525802] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:5057; }","duration":"118.213564ms","start":"2026-09-12T04:08:16.527392Z","end":"2026-09-12T04:08:16.645605Z","steps":["trace[63525802] 'agreement among raft nodes before linearized reading'  (duration: 118.115792ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:08:16.645869Z","caller":"traceutil/trace.go:171","msg":"trace[187798312] transaction","detail":"{read_only:false; response_revision:5057; number_of_response:1; }","duration":"124.685998ms","start":"2026-09-12T04:08:16.521172Z","end":"2026-09-12T04:08:16.645858Z","steps":["trace[187798312] 'process raft request'  (duration: 124.157662ms)"],"step_count":1}
{"level":"info","ts":"2026-09-12T04:08:57.465761Z","caller":"traceutil/trace.go:171","msg":"trace[1029984097] transaction","detail":"{read_only:false; response_revision:5406; number_of_response:1; }","duration":"342.896644ms","start":"2026-09-12T04:08:57.122825Z","end":"2026-09-12T04:08:57.465722Z","steps":["trace[1029984097] 'process raft request'  (duration: 342.708699ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-12T04:08:57.466076Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-12T04:08:57.122787Z","time spent":"343.138572ms","remote":"127.0.0.1:43150","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:5395 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:410 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-09-12T04:09:08.103421Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2873}
{"level":"info","ts":"2026-09-12T04:09:08.181956Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2873,"took":"77.209716ms","hash":2580460968,"current-db-size-bytes":53301248,"current-db-size":"53 MB","current-db-size-in-use-bytes":28565504,"current-db-size-in-use":"29 MB"}
{"level":"info","ts":"2026-09-12T04:09:08.18202Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2580460968,"revision":2873,"compact-revision":-1}
{"level":"info","ts":"2026-09-12T04:14:08.109085Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5484}
{"level":"info","ts":"2026-09-12T04:14:08.196839Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5484,"took":"86.078263ms","hash":3894351844,"current-db-size-bytes":53301248,"current-db-size":"53 MB","current-db-size-in-use-bytes":18530304,"current-db-size-in-use":"18 MB"}
{"level":"info","ts":"2026-09-12T04:14:08.197184Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3894351844,"revision":5484,"compact-revision":2873}