{"level":"warn","ts":"2026-04-23T14:18:58.781898Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-04-23T14:18:58.782003Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.248:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.248:2380","--initial-cluster=instance=https://199.204.45.248:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.248:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.248:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]}
{"level":"warn","ts":"2026-04-23T14:18:58.782076Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-04-23T14:18:58.782088Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.248:2380"]}
{"level":"info","ts":"2026-04-23T14:18:58.782106Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-04-23T14:18:58.782797Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"]}
{"level":"info","ts":"2026-04-23T14:18:58.782872Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.248:2380"],"listen-peer-urls":["https://199.204.45.248:2380"],"advertise-client-urls":["https://199.204.45.248:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.248:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"}
{"level":"info","ts":"2026-04-23T14:18:58.787608Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.4856ms"}
{"level":"info","ts":"2026-04-23T14:18:58.813349Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"39582465ceaa2f67","cluster-id":"87fd8ddedde3be45"}
{"level":"info","ts":"2026-04-23T14:18:58.813439Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=()"}
{"level":"info","ts":"2026-04-23T14:18:58.813463Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became follower at term 0"}
{"level":"info","ts":"2026-04-23T14:18:58.81348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 39582465ceaa2f67 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-04-23T14:18:58.813489Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became follower at term 1"}
{"level":"info","ts":"2026-04-23T14:18:58.813525Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=(4132092677789986663)"}
{"level":"warn","ts":"2026-04-23T14:18:58.823409Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-04-23T14:18:58.824738Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-04-23T14:18:58.826463Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"}
{"level":"info","ts":"2026-04-23T14:18:58.829845Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"39582465ceaa2f67","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-04-23T14:18:58.830783Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"}
{"level":"info","ts":"2026-04-23T14:18:58.830832Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"}
{"level":"info","ts":"2026-04-23T14:18:58.83084Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"}
{"level":"info","ts":"2026-04-23T14:18:58.83087Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"39582465ceaa2f67","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-04-23T14:18:58.832287Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=(4132092677789986663)"}
{"level":"info","ts":"2026-04-23T14:18:58.832482Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"87fd8ddedde3be45","local-member-id":"39582465ceaa2f67","added-peer-id":"39582465ceaa2f67","added-peer-peer-urls":["https://199.204.45.248:2380"]}
{"level":"info","ts":"2026-04-23T14:18:58.834512Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-04-23T14:18:58.834696Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"39582465ceaa2f67","initial-advertise-peer-urls":["https://199.204.45.248:2380"],"listen-peer-urls":["https://199.204.45.248:2380"],"advertise-client-urls":["https://199.204.45.248:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-04-23T14:18:58.834726Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-04-23T14:18:58.834825Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.248:2380"}
{"level":"info","ts":"2026-04-23T14:18:58.834838Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.248:2380"}
{"level":"info","ts":"2026-04-23T14:18:59.114768Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 is starting a new election at term 1"}
{"level":"info","ts":"2026-04-23T14:18:59.11487Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became pre-candidate at term 1"}
{"level":"info","ts":"2026-04-23T14:18:59.114932Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 received MsgPreVoteResp from 39582465ceaa2f67 at term 1"}
{"level":"info","ts":"2026-04-23T14:18:59.11496Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became candidate at term 2"}
{"level":"info","ts":"2026-04-23T14:18:59.114974Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 received MsgVoteResp from 39582465ceaa2f67 at term 2"}
{"level":"info","ts":"2026-04-23T14:18:59.115018Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became leader at term 2"}
{"level":"info","ts":"2026-04-23T14:18:59.115032Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 39582465ceaa2f67 elected leader 39582465ceaa2f67 at term 2"}
{"level":"info","ts":"2026-04-23T14:18:59.116128Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"39582465ceaa2f67","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.248:2379]}","request-path":"/0/members/39582465ceaa2f67/attributes","cluster-id":"87fd8ddedde3be45","publish-timeout":"7s"}
{"level":"info","ts":"2026-04-23T14:18:59.116459Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-23T14:18:59.116548Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-23T14:18:59.116567Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-23T14:18:59.117198Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-04-23T14:18:59.117256Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-04-23T14:18:59.117466Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"87fd8ddedde3be45","local-member-id":"39582465ceaa2f67","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-23T14:18:59.117552Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-23T14:18:59.117577Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-23T14:18:59.118744Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-04-23T14:18:59.127112Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.248:2379"}
{"level":"info","ts":"2026-04-23T14:19:00.785309Z","caller":"traceutil/trace.go:171","msg":"trace[636675116] linearizableReadLoop","detail":"{readStateIndex:8; appliedIndex:6; }","duration":"102.522178ms","start":"2026-04-23T14:19:00.682765Z","end":"2026-04-23T14:19:00.785287Z","steps":["trace[636675116] 'read index received'  (duration: 66.488574ms)","trace[636675116] 'applied index is now lower than readState.Index'  (duration: 36.032984ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:19:00.785419Z","caller":"traceutil/trace.go:171","msg":"trace[548504544] transaction","detail":"{read_only:false; response_revision:5; number_of_response:1; }","duration":"102.805644ms","start":"2026-04-23T14:19:00.682607Z","end":"2026-04-23T14:19:00.785413Z","steps":["trace[548504544] 'process raft request'  (duration: 102.381679ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:00.785529Z","caller":"traceutil/trace.go:171","msg":"trace[1275652150] transaction","detail":"{read_only:false; response_revision:6; number_of_response:1; }","duration":"102.619564ms","start":"2026-04-23T14:19:00.682905Z","end":"2026-04-23T14:19:00.785524Z","steps":["trace[1275652150] 'process raft request'  (duration: 102.163807ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:00.78559Z","caller":"traceutil/trace.go:171","msg":"trace[2057135817] transaction","detail":"{read_only:false; response_revision:7; number_of_response:1; }","duration":"102.257993ms","start":"2026-04-23T14:19:00.683327Z","end":"2026-04-23T14:19:00.785585Z","steps":["trace[2057135817] 'process raft request'  (duration: 101.833677ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:00.785646Z","caller":"traceutil/trace.go:171","msg":"trace[1472398002] transaction","detail":"{read_only:false; response_revision:8; number_of_response:1; }","duration":"102.220101ms","start":"2026-04-23T14:19:00.68342Z","end":"2026-04-23T14:19:00.78564Z","steps":["trace[1472398002] 'process raft request'  (duration: 101.765734ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:00.78569Z","caller":"traceutil/trace.go:171","msg":"trace[1151282229] transaction","detail":"{read_only:false; response_revision:9; number_of_response:1; }","duration":"102.232302ms","start":"2026-04-23T14:19:00.683453Z","end":"2026-04-23T14:19:00.785685Z","steps":["trace[1151282229] 'process raft request'  (duration: 101.754983ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:00.785939Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.133104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.248\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:00.785986Z","caller":"traceutil/trace.go:171","msg":"trace[1134471585] range","detail":"{range_begin:/registry/masterleases/199.204.45.248; range_end:; response_count:0; response_revision:11; }","duration":"103.23646ms","start":"2026-04-23T14:19:00.682742Z","end":"2026-04-23T14:19:00.785978Z","steps":["trace[1134471585] 'agreement among raft nodes before linearized reading'  (duration: 103.121253ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:00.830335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.354435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:00.830424Z","caller":"traceutil/trace.go:171","msg":"trace[1664027094] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:0; response_revision:12; }","duration":"141.473592ms","start":"2026-04-23T14:19:00.688927Z","end":"2026-04-23T14:19:00.8304Z","steps":["trace[1664027094] 'agreement among raft nodes before linearized reading'  (duration: 141.294471ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:00.830435Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.328575ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:00.830495Z","caller":"traceutil/trace.go:171","msg":"trace[2091945054] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:12; }","duration":"145.4075ms","start":"2026-04-23T14:19:00.685072Z","end":"2026-04-23T14:19:00.830479Z","steps":["trace[2091945054] 'agreement among raft nodes before linearized reading'  (duration: 145.301054ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:00.830718Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.655294ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:00.830818Z","caller":"traceutil/trace.go:171","msg":"trace[681424358] range","detail":"{range_begin:/registry/resourcequotas/kube-system/; range_end:/registry/resourcequotas/kube-system0; response_count:0; response_revision:12; }","duration":"146.866046ms","start":"2026-04-23T14:19:00.683923Z","end":"2026-04-23T14:19:00.830789Z","steps":["trace[681424358] 'agreement among raft nodes before linearized reading'  (duration: 146.649373ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.11238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.153178ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615436165 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.autoscaling\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.autoscaling\" value_size:874 >> failure:<>>","response":"size:14"}
{"level":"info","ts":"2026-04-23T14:19:01.112611Z","caller":"traceutil/trace.go:171","msg":"trace[1349662712] transaction","detail":"{read_only:false; response_revision:13; number_of_response:1; }","duration":"322.930366ms","start":"2026-04-23T14:19:00.789609Z","end":"2026-04-23T14:19:01.112539Z","steps":["trace[1349662712] 'process raft request'  (duration: 157.151253ms)","trace[1349662712] 'compare'  (duration: 165.03643ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:19:01.112753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.789597Z","time spent":"323.088865ms","remote":"127.0.0.1:54276","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.autoscaling\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.autoscaling\" value_size:874 >> failure:<>"}
{"level":"info","ts":"2026-04-23T14:19:01.112775Z","caller":"traceutil/trace.go:171","msg":"trace[452310353] transaction","detail":"{read_only:false; response_revision:20; number_of_response:1; }","duration":"278.375747ms","start":"2026-04-23T14:19:00.834378Z","end":"2026-04-23T14:19:01.112754Z","steps":["trace[452310353] 'process raft request'  (duration: 278.324994ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.113Z","caller":"traceutil/trace.go:171","msg":"trace[819859336] linearizableReadLoop","detail":"{readStateIndex:21; appliedIndex:15; }","duration":"282.843017ms","start":"2026-04-23T14:19:00.830144Z","end":"2026-04-23T14:19:01.112987Z","steps":["trace[819859336] 'read index received'  (duration: 116.631349ms)","trace[819859336] 'applied index is now lower than readState.Index'  (duration: 166.209688ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:19:01.113061Z","caller":"traceutil/trace.go:171","msg":"trace[1459375286] transaction","detail":"{read_only:false; response_revision:17; number_of_response:1; }","duration":"322.626549ms","start":"2026-04-23T14:19:00.790406Z","end":"2026-04-23T14:19:01.113033Z","steps":["trace[1459375286] 'process raft request'  (duration: 322.179083ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.113072Z","caller":"traceutil/trace.go:171","msg":"trace[324394834] transaction","detail":"{read_only:false; number_of_response:0; response_revision:19; }","duration":"278.871636ms","start":"2026-04-23T14:19:00.834163Z","end":"2026-04-23T14:19:01.113034Z","steps":["trace[324394834] 'process raft request'  (duration: 278.528256ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113138Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.790397Z","time spent":"322.690842ms","remote":"127.0.0.1:54276","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":965,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.certificates.k8s.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.certificates.k8s.io\" value_size:890 >> failure:<>"}
{"level":"warn","ts":"2026-04-23T14:19:01.113278Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"324.88657ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:01.113333Z","caller":"traceutil/trace.go:171","msg":"trace[1502094116] transaction","detail":"{read_only:false; response_revision:18; number_of_response:1; }","duration":"317.612167ms","start":"2026-04-23T14:19:00.79571Z","end":"2026-04-23T14:19:01.113323Z","steps":["trace[1502094116] 'process raft request'  (duration: 316.904556ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.113335Z","caller":"traceutil/trace.go:171","msg":"trace[1640995059] transaction","detail":"{read_only:false; response_revision:15; number_of_response:1; }","duration":"323.438376ms","start":"2026-04-23T14:19:00.789873Z","end":"2026-04-23T14:19:01.113311Z","steps":["trace[1640995059] 'process raft request'  (duration: 322.630698ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113392Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.040766ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3491"}
{"level":"warn","ts":"2026-04-23T14:19:01.113427Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.789863Z","time spent":"323.534832ms","remote":"127.0.0.1:54276","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.authorization.k8s.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.authorization.k8s.io\" value_size:892 >> failure:<>"}
{"level":"info","ts":"2026-04-23T14:19:01.113433Z","caller":"traceutil/trace.go:171","msg":"trace[1636231303] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:20; }","duration":"279.125221ms","start":"2026-04-23T14:19:00.834296Z","end":"2026-04-23T14:19:01.113421Z","steps":["trace[1636231303] 'agreement among raft nodes before linearized reading'  (duration: 279.027726ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.113415Z","caller":"traceutil/trace.go:171","msg":"trace[380759075] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:20; }","duration":"325.026768ms","start":"2026-04-23T14:19:00.78834Z","end":"2026-04-23T14:19:01.113367Z","steps":["trace[380759075] 'agreement among raft nodes before linearized reading'  (duration: 324.864328ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113549Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.7957Z","time spent":"317.678352ms","remote":"127.0.0.1:53966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3479,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:10 > success:<request_put:<key:\"/registry/minions/instance\" value_size:3445 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"info","ts":"2026-04-23T14:19:01.113594Z","caller":"traceutil/trace.go:171","msg":"trace[20559642] transaction","detail":"{read_only:false; response_revision:14; number_of_response:1; }","duration":"323.870442ms","start":"2026-04-23T14:19:00.789713Z","end":"2026-04-23T14:19:01.113583Z","steps":["trace[20559642] 'process raft request'  (duration: 322.750376ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113575Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.788294Z","time spent":"325.263722ms","remote":"127.0.0.1:53810","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-04-23T14:19:01.113764Z","caller":"traceutil/trace.go:171","msg":"trace[965850326] transaction","detail":"{read_only:false; response_revision:16; number_of_response:1; }","duration":"323.837299ms","start":"2026-04-23T14:19:00.789917Z","end":"2026-04-23T14:19:01.113755Z","steps":["trace[965850326] 'process raft request'  (duration: 322.64503ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113646Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.96808ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:350"}
{"level":"warn","ts":"2026-04-23T14:19:01.113794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"323.498989ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/csr-kw296\" ","response":"range_response_count:1 size:861"}
{"level":"warn","ts":"2026-04-23T14:19:01.11382Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.789911Z","time spent":"323.884192ms","remote":"127.0.0.1:54276","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v2.autoscaling\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v2.autoscaling\" value_size:874 >> failure:<>"}
{"level":"info","ts":"2026-04-23T14:19:01.113838Z","caller":"traceutil/trace.go:171","msg":"trace[587633513] range","detail":"{range_begin:/registry/certificatesigningrequests/csr-kw296; range_end:; response_count:1; response_revision:20; }","duration":"323.579135ms","start":"2026-04-23T14:19:00.790248Z","end":"2026-04-23T14:19:01.113827Z","steps":["trace[587633513] 'agreement among raft nodes before linearized reading'  (duration: 323.471228ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.790235Z","time spent":"323.629477ms","remote":"127.0.0.1:54036","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":884,"request content":"key:\"/registry/certificatesigningrequests/csr-kw296\" "}
{"level":"info","ts":"2026-04-23T14:19:01.113806Z","caller":"traceutil/trace.go:171","msg":"trace[589939069] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:20; }","duration":"222.14638ms","start":"2026-04-23T14:19:00.89165Z","end":"2026-04-23T14:19:01.113796Z","steps":["trace[589939069] 'agreement among raft nodes before linearized reading'  (duration: 221.96834ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.113429Z","caller":"traceutil/trace.go:171","msg":"trace[733436731] transaction","detail":"{read_only:false; response_revision:19; number_of_response:1; }","duration":"280.353733ms","start":"2026-04-23T14:19:00.833062Z","end":"2026-04-23T14:19:01.113416Z","steps":["trace[733436731] 'process raft request'  (duration: 279.602319ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113719Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.570894ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-04-23T14:19:01.114058Z","caller":"traceutil/trace.go:171","msg":"trace[1105962605] range","detail":"{range_begin:/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te; range_end:; response_count:0; response_revision:20; }","duration":"233.942495ms","start":"2026-04-23T14:19:00.880103Z","end":"2026-04-23T14:19:01.114046Z","steps":["trace[1105962605] 'agreement among raft nodes before linearized reading'  (duration: 233.571434ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:01.113651Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:19:00.789705Z","time spent":"323.913234ms","remote":"127.0.0.1:54276","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":923,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.batch\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.batch\" value_size:862 >> failure:<>"}
{"level":"info","ts":"2026-04-23T14:19:01.29323Z","caller":"traceutil/trace.go:171","msg":"trace[881502789] transaction","detail":"{read_only:false; response_revision:30; number_of_response:1; }","duration":"123.329427ms","start":"2026-04-23T14:19:01.16969Z","end":"2026-04-23T14:19:01.293019Z","steps":["trace[881502789] 'process raft request'  (duration: 94.66003ms)","trace[881502789] 'compare'  (duration: 28.554171ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:19:01.310133Z","caller":"traceutil/trace.go:171","msg":"trace[2038479437] transaction","detail":"{read_only:false; response_revision:31; number_of_response:1; }","duration":"140.373987ms","start":"2026-04-23T14:19:01.169733Z","end":"2026-04-23T14:19:01.310107Z","steps":["trace[2038479437] 'process raft request'  (duration: 139.976234ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310206Z","caller":"traceutil/trace.go:171","msg":"trace[321900066] transaction","detail":"{read_only:false; response_revision:34; number_of_response:1; }","duration":"140.063249ms","start":"2026-04-23T14:19:01.170134Z","end":"2026-04-23T14:19:01.310197Z","steps":["trace[321900066] 'process raft request'  (duration: 139.856107ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310324Z","caller":"traceutil/trace.go:171","msg":"trace[2076121754] transaction","detail":"{read_only:false; response_revision:33; number_of_response:1; }","duration":"140.25368ms","start":"2026-04-23T14:19:01.170063Z","end":"2026-04-23T14:19:01.310316Z","steps":["trace[2076121754] 'process raft request'  (duration: 139.862058ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310151Z","caller":"traceutil/trace.go:171","msg":"trace[1654703414] transaction","detail":"{read_only:false; response_revision:32; number_of_response:1; }","duration":"140.267861ms","start":"2026-04-23T14:19:01.169859Z","end":"2026-04-23T14:19:01.310126Z","steps":["trace[1654703414] 'process raft request'  (duration: 139.982605ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310322Z","caller":"traceutil/trace.go:171","msg":"trace[1715212110] transaction","detail":"{read_only:false; response_revision:36; number_of_response:1; }","duration":"139.929181ms","start":"2026-04-23T14:19:01.170284Z","end":"2026-04-23T14:19:01.310213Z","steps":["trace[1715212110] 'process raft request'  (duration: 139.759692ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310409Z","caller":"traceutil/trace.go:171","msg":"trace[1964251255] transaction","detail":"{read_only:false; response_revision:37; number_of_response:1; }","duration":"140.086971ms","start":"2026-04-23T14:19:01.170295Z","end":"2026-04-23T14:19:01.310382Z","steps":["trace[1964251255] 'process raft request'  (duration: 139.771323ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:01.310521Z","caller":"traceutil/trace.go:171","msg":"trace[4815396] transaction","detail":"{read_only:false; response_revision:35; number_of_response:1; }","duration":"140.362857ms","start":"2026-04-23T14:19:01.17014Z","end":"2026-04-23T14:19:01.310503Z","steps":["trace[4815396] 'process raft request'  (duration: 139.875899ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:31.847891Z","caller":"traceutil/trace.go:171","msg":"trace[773656501] transaction","detail":"{read_only:false; response_revision:573; number_of_response:1; }","duration":"190.662301ms","start":"2026-04-23T14:19:31.65721Z","end":"2026-04-23T14:19:31.847873Z","steps":["trace[773656501] 'process raft request'  (duration: 190.626887ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:19:31.847948Z","caller":"traceutil/trace.go:171","msg":"trace[1661916428] transaction","detail":"{read_only:false; response_revision:572; number_of_response:1; }","duration":"223.732279ms","start":"2026-04-23T14:19:31.624162Z","end":"2026-04-23T14:19:31.847894Z","steps":["trace[1661916428] 'process raft request'  (duration: 187.698714ms)","trace[1661916428] 'compare'  (duration: 35.860852ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:19:32.349223Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.08645ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615437260 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:422 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:599 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:19:32.349751Z","caller":"traceutil/trace.go:171","msg":"trace[994234962] linearizableReadLoop","detail":"{readStateIndex:600; appliedIndex:599; }","duration":"173.687903ms","start":"2026-04-23T14:19:32.176044Z","end":"2026-04-23T14:19:32.349732Z","steps":["trace[994234962] 'read index received'  (duration: 62.93469ms)","trace[994234962] 'applied index is now lower than readState.Index'  (duration: 110.751864ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:19:32.349797Z","caller":"traceutil/trace.go:171","msg":"trace[898044611] transaction","detail":"{read_only:false; response_revision:574; number_of_response:1; }","duration":"212.029997ms","start":"2026-04-23T14:19:32.137735Z","end":"2026-04-23T14:19:32.349765Z","steps":["trace[898044611] 'process raft request'  (duration: 101.322564ms)","trace[898044611] 'compare'  (duration: 109.948651ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:19:32.349917Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.850031ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:19:32.349989Z","caller":"traceutil/trace.go:171","msg":"trace[1714738728] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:574; }","duration":"173.979282ms","start":"2026-04-23T14:19:32.175991Z","end":"2026-04-23T14:19:32.34997Z","steps":["trace[1714738728] 'agreement among raft nodes before linearized reading'  (duration: 173.838005ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:19:47.168876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.618221ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-04-23T14:19:47.168945Z","caller":"traceutil/trace.go:171","msg":"trace[727904000] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:730; }","duration":"182.753664ms","start":"2026-04-23T14:19:46.986177Z","end":"2026-04-23T14:19:47.168931Z","steps":["trace[727904000] 'range keys from in-memory index tree'  (duration: 182.458316ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:20.100873Z","caller":"traceutil/trace.go:171","msg":"trace[600390810] transaction","detail":"{read_only:false; response_revision:1533; number_of_response:1; }","duration":"130.933936ms","start":"2026-04-23T14:23:19.969909Z","end":"2026-04-23T14:23:20.100843Z","steps":["trace[600390810] 'process raft request'  (duration: 130.546104ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:25.734761Z","caller":"traceutil/trace.go:171","msg":"trace[1777924705] transaction","detail":"{read_only:false; response_revision:1552; number_of_response:1; }","duration":"122.250059ms","start":"2026-04-23T14:23:25.612492Z","end":"2026-04-23T14:23:25.734742Z","steps":["trace[1777924705] 'process raft request'  (duration: 122.127425ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:26.343347Z","caller":"traceutil/trace.go:171","msg":"trace[1115355661] linearizableReadLoop","detail":"{readStateIndex:1629; appliedIndex:1628; }","duration":"181.019466ms","start":"2026-04-23T14:23:26.162301Z","end":"2026-04-23T14:23:26.343321Z","steps":["trace[1115355661] 'read index received'  (duration: 180.80469ms)","trace[1115355661] 'applied index is now lower than readState.Index'  (duration: 213.836µs)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:23:26.343406Z","caller":"traceutil/trace.go:171","msg":"trace[455853692] transaction","detail":"{read_only:false; response_revision:1553; number_of_response:1; }","duration":"185.094792ms","start":"2026-04-23T14:23:26.158284Z","end":"2026-04-23T14:23:26.343379Z","steps":["trace[455853692] 'process raft request'  (duration: 184.799413ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:23:26.343582Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.271744ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-04-23T14:23:26.343618Z","caller":"traceutil/trace.go:171","msg":"trace[796087533] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1553; }","duration":"181.414447ms","start":"2026-04-23T14:23:26.162192Z","end":"2026-04-23T14:23:26.343606Z","steps":["trace[796087533] 'agreement among raft nodes before linearized reading'  (duration: 181.275963ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:23:26.343596Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.530049ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:23:26.343688Z","caller":"traceutil/trace.go:171","msg":"trace[867329678] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1553; }","duration":"169.651663ms","start":"2026-04-23T14:23:26.174015Z","end":"2026-04-23T14:23:26.343666Z","steps":["trace[867329678] 'agreement among raft nodes before linearized reading'  (duration: 169.528959ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:23:50.753444Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.866926ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-04-23T14:23:50.753522Z","caller":"traceutil/trace.go:171","msg":"trace[978992436] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1632; }","duration":"206.99059ms","start":"2026-04-23T14:23:50.546514Z","end":"2026-04-23T14:23:50.753505Z","steps":["trace[978992436] 'range keys from in-memory index tree'  (duration: 206.69428ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:23:50.753866Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.986502ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-04-23T14:23:50.753923Z","caller":"traceutil/trace.go:171","msg":"trace[359502765] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1632; }","duration":"206.070574ms","start":"2026-04-23T14:23:50.547835Z","end":"2026-04-23T14:23:50.753906Z","steps":["trace[359502765] 'range keys from in-memory index tree'  (duration: 205.890409ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:50.967539Z","caller":"traceutil/trace.go:171","msg":"trace[2124541268] transaction","detail":"{read_only:false; response_revision:1633; number_of_response:1; }","duration":"210.099807ms","start":"2026-04-23T14:23:50.757418Z","end":"2026-04-23T14:23:50.967518Z","steps":["trace[2124541268] 'process raft request'  (duration: 209.984184ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:50.977553Z","caller":"traceutil/trace.go:171","msg":"trace[329129543] transaction","detail":"{read_only:false; response_revision:1634; number_of_response:1; }","duration":"219.483145ms","start":"2026-04-23T14:23:50.75805Z","end":"2026-04-23T14:23:50.977534Z","steps":["trace[329129543] 'process raft request'  (duration: 219.34579ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:50.977949Z","caller":"traceutil/trace.go:171","msg":"trace[1683425387] linearizableReadLoop","detail":"{readStateIndex:1716; appliedIndex:1713; }","duration":"190.506002ms","start":"2026-04-23T14:23:50.78743Z","end":"2026-04-23T14:23:50.977936Z","steps":["trace[1683425387] 'read index received'  (duration: 180.054265ms)","trace[1683425387] 'applied index is now lower than readState.Index'  (duration: 10.450737ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:23:50.978099Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.663257ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-04-23T14:23:50.978136Z","caller":"traceutil/trace.go:171","msg":"trace[672813551] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1635; }","duration":"190.772ms","start":"2026-04-23T14:23:50.787355Z","end":"2026-04-23T14:23:50.978127Z","steps":["trace[672813551] 'agreement among raft nodes before linearized reading'  (duration: 190.631586ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:23:50.978274Z","caller":"traceutil/trace.go:171","msg":"trace[871661580] transaction","detail":"{read_only:false; response_revision:1635; number_of_response:1; }","duration":"219.882026ms","start":"2026-04-23T14:23:50.758359Z","end":"2026-04-23T14:23:50.978241Z","steps":["trace[871661580] 'process raft request'  (duration: 219.139585ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:23:51.202023Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.567571ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615439896 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:1630 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:368 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:23:51.202394Z","caller":"traceutil/trace.go:171","msg":"trace[1203888722] transaction","detail":"{read_only:false; response_revision:1637; number_of_response:1; }","duration":"163.063664ms","start":"2026-04-23T14:23:51.039305Z","end":"2026-04-23T14:23:51.202369Z","steps":["trace[1203888722] 'process raft request'  (duration: 62.072551ms)","trace[1203888722] 'compare'  (duration: 100.449378ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:23:52.598745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.651392ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615439904 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/masterleases/199.204.45.248\" mod_revision:1606 > success:<request_put:<key:\"/registry/masterleases/199.204.45.248\" value_size:67 lease:3415872267615439902 >> failure:<request_range:<key:\"/registry/masterleases/199.204.45.248\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:23:52.599132Z","caller":"traceutil/trace.go:171","msg":"trace[25663136] transaction","detail":"{read_only:false; response_revision:1639; number_of_response:1; }","duration":"216.961872ms","start":"2026-04-23T14:23:52.382131Z","end":"2026-04-23T14:23:52.599093Z","steps":["trace[25663136] 'process raft request'  (duration: 108.873028ms)","trace[25663136] 'compare'  (duration: 107.465357ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:23:54.179717Z","caller":"traceutil/trace.go:171","msg":"trace[816525010] transaction","detail":"{read_only:false; response_revision:1645; number_of_response:1; }","duration":"279.28015ms","start":"2026-04-23T14:23:53.900396Z","end":"2026-04-23T14:23:54.179676Z","steps":["trace[816525010] 'process raft request'  (duration: 279.129556ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:09.327516Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.036544ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"warn","ts":"2026-04-23T14:24:09.327535Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.28771ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:09.327596Z","caller":"traceutil/trace.go:171","msg":"trace[2046719589] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1745; }","duration":"205.160398ms","start":"2026-04-23T14:24:09.122416Z","end":"2026-04-23T14:24:09.327577Z","steps":["trace[2046719589] 'range keys from in-memory index tree'  (duration: 204.859499ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:09.327562Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.896317ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-04-23T14:24:09.327614Z","caller":"traceutil/trace.go:171","msg":"trace[512749348] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1745; }","duration":"151.412013ms","start":"2026-04-23T14:24:09.176187Z","end":"2026-04-23T14:24:09.327599Z","steps":["trace[512749348] 'range keys from in-memory index tree'  (duration: 151.197157ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:09.327656Z","caller":"traceutil/trace.go:171","msg":"trace[1837644511] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1745; }","duration":"152.029101ms","start":"2026-04-23T14:24:09.175604Z","end":"2026-04-23T14:24:09.327633Z","steps":["trace[1837644511] 'range keys from in-memory index tree'  (duration: 151.710642ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:09.327794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.557471ms","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-04-23T14:24:09.327878Z","caller":"traceutil/trace.go:171","msg":"trace[2035228703] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1745; }","duration":"143.699505ms","start":"2026-04-23T14:24:09.184161Z","end":"2026-04-23T14:24:09.32786Z","steps":["trace[2035228703] 'range keys from in-memory index tree'  (duration: 143.364005ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:11.017904Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.693481ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:11.01799Z","caller":"traceutil/trace.go:171","msg":"trace[1499738536] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:1750; }","duration":"182.829705ms","start":"2026-04-23T14:24:10.835141Z","end":"2026-04-23T14:24:11.017971Z","steps":["trace[1499738536] 'count revisions from in-memory index tree'  (duration: 182.617978ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:11.045121Z","caller":"traceutil/trace.go:171","msg":"trace[1589731499] transaction","detail":"{read_only:false; response_revision:1751; number_of_response:1; }","duration":"172.43947ms","start":"2026-04-23T14:24:10.872634Z","end":"2026-04-23T14:24:11.045073Z","steps":["trace[1589731499] 'process raft request'  (duration: 172.288356ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:24.616575Z","caller":"traceutil/trace.go:171","msg":"trace[694956992] transaction","detail":"{read_only:false; response_revision:1797; number_of_response:1; }","duration":"112.446268ms","start":"2026-04-23T14:24:24.504109Z","end":"2026-04-23T14:24:24.616555Z","steps":["trace[694956992] 'process raft request'  (duration: 111.934614ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:25.854046Z","caller":"traceutil/trace.go:171","msg":"trace[1690241579] linearizableReadLoop","detail":"{readStateIndex:1890; appliedIndex:1889; }","duration":"271.222102ms","start":"2026-04-23T14:24:25.582792Z","end":"2026-04-23T14:24:25.854014Z","steps":["trace[1690241579] 'read index received'  (duration: 270.991895ms)","trace[1690241579] 'applied index is now lower than readState.Index'  (duration: 228.137µs)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:25.854146Z","caller":"traceutil/trace.go:171","msg":"trace[1595497267] transaction","detail":"{read_only:false; response_revision:1800; number_of_response:1; }","duration":"290.642502ms","start":"2026-04-23T14:24:25.563473Z","end":"2026-04-23T14:24:25.854115Z","steps":["trace[1595497267] 'process raft request'  (duration: 290.345543ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:25.854338Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.53014ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-04-23T14:24:25.854383Z","caller":"traceutil/trace.go:171","msg":"trace[514405817] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1800; }","duration":"271.596562ms","start":"2026-04-23T14:24:25.582774Z","end":"2026-04-23T14:24:25.854371Z","steps":["trace[514405817] 'agreement among raft nodes before linearized reading'  (duration: 271.431657ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:25.854505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.335783ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"info","ts":"2026-04-23T14:24:25.854602Z","caller":"traceutil/trace.go:171","msg":"trace[373977715] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1800; }","duration":"229.491527ms","start":"2026-04-23T14:24:25.625092Z","end":"2026-04-23T14:24:25.854583Z","steps":["trace[373977715] 'agreement among raft nodes before linearized reading'  (duration: 229.180008ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:30.187187Z","caller":"traceutil/trace.go:171","msg":"trace[1380802853] linearizableReadLoop","detail":"{readStateIndex:1930; appliedIndex:1929; }","duration":"326.266031ms","start":"2026-04-23T14:24:29.860892Z","end":"2026-04-23T14:24:30.187158Z","steps":["trace[1380802853] 'read index received'  (duration: 236.782074ms)","trace[1380802853] 'applied index is now lower than readState.Index'  (duration: 89.480227ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:30.187353Z","caller":"traceutil/trace.go:171","msg":"trace[233659752] transaction","detail":"{read_only:false; response_revision:1839; number_of_response:1; }","duration":"397.546573ms","start":"2026-04-23T14:24:29.789791Z","end":"2026-04-23T14:24:30.187338Z","steps":["trace[233659752] 'process raft request'  (duration: 307.936672ms)","trace[233659752] 'compare'  (duration: 89.220101ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:30.187672Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:29.789775Z","time spent":"397.610836ms","remote":"127.0.0.1:54164","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":797,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/csinodes/instance\" mod_revision:22 > success:<request_put:<key:\"/registry/csinodes/instance\" value_size:762 >> failure:<request_range:<key:\"/registry/csinodes/instance\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:30.187725Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.815287ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:30.187803Z","caller":"traceutil/trace.go:171","msg":"trace[1930761052] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:1839; }","duration":"326.935961ms","start":"2026-04-23T14:24:29.860843Z","end":"2026-04-23T14:24:30.187779Z","steps":["trace[1930761052] 'agreement among raft nodes before linearized reading'  (duration: 326.808457ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.188432Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:29.860823Z","time spent":"327.584988ms","remote":"127.0.0.1:38800","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true "}
{"level":"warn","ts":"2026-04-23T14:24:30.187918Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"267.589688ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"warn","ts":"2026-04-23T14:24:30.188035Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.984727ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"info","ts":"2026-04-23T14:24:30.188887Z","caller":"traceutil/trace.go:171","msg":"trace[1144701608] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1839; }","duration":"299.867043ms","start":"2026-04-23T14:24:29.889Z","end":"2026-04-23T14:24:30.188867Z","steps":["trace[1144701608] 'agreement among raft nodes before linearized reading'  (duration: 298.736221ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.188142Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"320.960661ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-04-23T14:24:30.189067Z","caller":"traceutil/trace.go:171","msg":"trace[1921234097] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1839; }","duration":"268.235217ms","start":"2026-04-23T14:24:29.920298Z","end":"2026-04-23T14:24:30.188533Z","steps":["trace[1921234097] 'agreement among raft nodes before linearized reading'  (duration: 267.423193ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:30.189137Z","caller":"traceutil/trace.go:171","msg":"trace[875474571] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1839; }","duration":"321.97929ms","start":"2026-04-23T14:24:29.867138Z","end":"2026-04-23T14:24:30.189117Z","steps":["trace[875474571] 'agreement among raft nodes before linearized reading'  (duration: 320.94585ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.189186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:29.867119Z","time spent":"322.055883ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-04-23T14:24:30.55236Z","caller":"traceutil/trace.go:171","msg":"trace[2009515355] transaction","detail":"{read_only:false; response_revision:1840; number_of_response:1; }","duration":"359.602818ms","start":"2026-04-23T14:24:30.192729Z","end":"2026-04-23T14:24:30.552332Z","steps":["trace[2009515355] 'process raft request'  (duration: 284.866829ms)","trace[2009515355] 'compare'  (duration: 74.608665ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:30.552513Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:30.192715Z","time spent":"359.730151ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:1816 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-04-23T14:24:30.579523Z","caller":"traceutil/trace.go:171","msg":"trace[1186824995] transaction","detail":"{read_only:false; response_revision:1841; number_of_response:1; }","duration":"385.947205ms","start":"2026-04-23T14:24:30.193546Z","end":"2026-04-23T14:24:30.579493Z","steps":["trace[1186824995] 'process raft request'  (duration: 385.712999ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:30.579555Z","caller":"traceutil/trace.go:171","msg":"trace[492021881] transaction","detail":"{read_only:false; response_revision:1842; number_of_response:1; }","duration":"385.809351ms","start":"2026-04-23T14:24:30.193726Z","end":"2026-04-23T14:24:30.579535Z","steps":["trace[492021881] 'process raft request'  (duration: 385.652037ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:30.579482Z","caller":"traceutil/trace.go:171","msg":"trace[1895156859] linearizableReadLoop","detail":"{readStateIndex:1934; appliedIndex:1930; }","duration":"297.072564ms","start":"2026-04-23T14:24:30.282383Z","end":"2026-04-23T14:24:30.579455Z","steps":["trace[1895156859] 'read index received'  (duration: 195.441822ms)","trace[1895156859] 'applied index is now lower than readState.Index'  (duration: 101.629412ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:30.579622Z","caller":"traceutil/trace.go:171","msg":"trace[625403263] transaction","detail":"{read_only:false; response_revision:1843; number_of_response:1; }","duration":"385.77381ms","start":"2026-04-23T14:24:30.193812Z","end":"2026-04-23T14:24:30.579585Z","steps":["trace[625403263] 'process raft request'  (duration: 385.605565ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.579776Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:30.193717Z","time spent":"385.882533ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:1814 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:30.57992Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:30.193806Z","time spent":"385.988747ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:1815 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:30.57967Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:30.193528Z","time spent":"386.063098ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":767,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/default/test-pvc-pod.18a9027e2198b695\" mod_revision:1824 > success:<request_put:<key:\"/registry/events/default/test-pvc-pod.18a9027e2198b695\" value_size:695 lease:3415872267615440088 >> failure:<request_range:<key:\"/registry/events/default/test-pvc-pod.18a9027e2198b695\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:30.580155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.30821ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:30.580254Z","caller":"traceutil/trace.go:171","msg":"trace[140875927] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:1843; }","duration":"297.896537ms","start":"2026-04-23T14:24:30.282342Z","end":"2026-04-23T14:24:30.580239Z","steps":["trace[140875927] 'agreement among raft nodes before linearized reading'  (duration: 297.246849ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.99713Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"329.104002ms","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-04-23T14:24:30.997211Z","caller":"traceutil/trace.go:171","msg":"trace[1218999764] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1843; }","duration":"329.268207ms","start":"2026-04-23T14:24:30.667925Z","end":"2026-04-23T14:24:30.997193Z","steps":["trace[1218999764] 'range keys from in-memory index tree'  (duration: 328.885266ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:30.997262Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:30.667899Z","time spent":"329.343299ms","remote":"127.0.0.1:54042","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-04-23T14:24:31.233768Z","caller":"traceutil/trace.go:171","msg":"trace[1734906475] transaction","detail":"{read_only:false; response_revision:1844; number_of_response:1; }","duration":"232.562875ms","start":"2026-04-23T14:24:31.001181Z","end":"2026-04-23T14:24:31.233744Z","steps":["trace[1734906475] 'process raft request'  (duration: 232.396471ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:31.778582Z","caller":"traceutil/trace.go:171","msg":"trace[1790350431] linearizableReadLoop","detail":"{readStateIndex:1936; appliedIndex:1935; }","duration":"286.455203ms","start":"2026-04-23T14:24:31.492099Z","end":"2026-04-23T14:24:31.778554Z","steps":["trace[1790350431] 'read index received'  (duration: 286.254407ms)","trace[1790350431] 'applied index is now lower than readState.Index'  (duration: 199.556µs)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:31.778606Z","caller":"traceutil/trace.go:171","msg":"trace[1605549164] transaction","detail":"{read_only:false; response_revision:1845; number_of_response:1; }","duration":"550.761179ms","start":"2026-04-23T14:24:31.227818Z","end":"2026-04-23T14:24:31.778579Z","steps":["trace[1605549164] 'process raft request'  (duration: 550.564653ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:31.778753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:31.227793Z","time spent":"550.888643ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:1831 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:458 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:31.778786Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"286.670919ms","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-04-23T14:24:31.778822Z","caller":"traceutil/trace.go:171","msg":"trace[754071115] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1845; }","duration":"286.767851ms","start":"2026-04-23T14:24:31.492042Z","end":"2026-04-23T14:24:31.77881Z","steps":["trace[754071115] 'agreement among raft nodes before linearized reading'  (duration: 286.615657ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:32.171987Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"346.65185ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440381 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:1785 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:32.172179Z","caller":"traceutil/trace.go:171","msg":"trace[2112544592] transaction","detail":"{read_only:false; response_revision:1847; number_of_response:1; }","duration":"390.409391ms","start":"2026-04-23T14:24:31.781754Z","end":"2026-04-23T14:24:32.172163Z","steps":["trace[2112544592] 'process raft request'  (duration: 390.331469ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:32.172248Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:31.781738Z","time spent":"390.469083ms","remote":"127.0.0.1:54042","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:1833 > 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-04-23T14:24:32.172237Z","caller":"traceutil/trace.go:171","msg":"trace[1038547812] transaction","detail":"{read_only:false; response_revision:1846; number_of_response:1; }","duration":"538.229443ms","start":"2026-04-23T14:24:31.633971Z","end":"2026-04-23T14:24:32.172201Z","steps":["trace[1038547812] 'process raft request'  (duration: 191.274574ms)","trace[1038547812] 'compare'  (duration: 346.341911ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:32.1724Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:31.633947Z","time spent":"538.367577ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:1785 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:32.458086Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.116659ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.248\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-04-23T14:24:32.458249Z","caller":"traceutil/trace.go:171","msg":"trace[783401778] range","detail":"{range_begin:/registry/masterleases/199.204.45.248; range_end:; response_count:1; response_revision:1847; }","duration":"119.327774ms","start":"2026-04-23T14:24:32.3389Z","end":"2026-04-23T14:24:32.458228Z","steps":["trace[783401778] 'range keys from in-memory index tree'  (duration: 118.918303ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:32.776245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.132829ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440390 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/masterleases/199.204.45.248\" mod_revision:1790 > success:<request_put:<key:\"/registry/masterleases/199.204.45.248\" value_size:67 lease:3415872267615440387 >> failure:<request_range:<key:\"/registry/masterleases/199.204.45.248\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:32.776455Z","caller":"traceutil/trace.go:171","msg":"trace[375595911] transaction","detail":"{read_only:false; response_revision:1848; number_of_response:1; }","duration":"274.154004ms","start":"2026-04-23T14:24:32.502258Z","end":"2026-04-23T14:24:32.776412Z","steps":["trace[375595911] 'process raft request'  (duration: 130.753508ms)","trace[375595911] 'compare'  (duration: 142.974775ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:32.77657Z","caller":"traceutil/trace.go:171","msg":"trace[1984647739] linearizableReadLoop","detail":"{readStateIndex:1940; appliedIndex:1939; }","duration":"220.434101ms","start":"2026-04-23T14:24:32.556052Z","end":"2026-04-23T14:24:32.776486Z","steps":["trace[1984647739] 'read index received'  (duration: 77.002093ms)","trace[1984647739] 'applied index is now lower than readState.Index'  (duration: 143.429998ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:32.776889Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.737364ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"warn","ts":"2026-04-23T14:24:32.77689Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.436276ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"info","ts":"2026-04-23T14:24:32.77696Z","caller":"traceutil/trace.go:171","msg":"trace[1611113182] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1848; }","duration":"192.545589ms","start":"2026-04-23T14:24:32.5844Z","end":"2026-04-23T14:24:32.776945Z","steps":["trace[1611113182] 'agreement among raft nodes before linearized reading'  (duration: 192.365094ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:32.777094Z","caller":"traceutil/trace.go:171","msg":"trace[872791236] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1848; }","duration":"192.842048ms","start":"2026-04-23T14:24:32.584093Z","end":"2026-04-23T14:24:32.776935Z","steps":["trace[872791236] 'agreement among raft nodes before linearized reading'  (duration: 192.623932ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:32.777379Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.220133ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-04-23T14:24:32.777585Z","caller":"traceutil/trace.go:171","msg":"trace[600922006] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1848; }","duration":"221.551613ms","start":"2026-04-23T14:24:32.556005Z","end":"2026-04-23T14:24:32.777557Z","steps":["trace[600922006] 'agreement among raft nodes before linearized reading'  (duration: 220.666607ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:33.051582Z","caller":"traceutil/trace.go:171","msg":"trace[984002427] linearizableReadLoop","detail":"{readStateIndex:1943; appliedIndex:1940; }","duration":"269.044001ms","start":"2026-04-23T14:24:32.782515Z","end":"2026-04-23T14:24:33.051559Z","steps":["trace[984002427] 'read index received'  (duration: 27.951353ms)","trace[984002427] 'applied index is now lower than readState.Index'  (duration: 241.091438ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:33.051656Z","caller":"traceutil/trace.go:171","msg":"trace[1945045330] transaction","detail":"{read_only:false; response_revision:1850; number_of_response:1; }","duration":"270.1255ms","start":"2026-04-23T14:24:32.781492Z","end":"2026-04-23T14:24:33.051617Z","steps":["trace[1945045330] 'process raft request'  (duration: 227.880072ms)","trace[1945045330] 'compare'  (duration: 42.004291ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:33.051873Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.82358ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:33.051673Z","caller":"traceutil/trace.go:171","msg":"trace[521953860] transaction","detail":"{read_only:false; response_revision:1851; number_of_response:1; }","duration":"270.10933ms","start":"2026-04-23T14:24:32.78154Z","end":"2026-04-23T14:24:33.051649Z","steps":["trace[521953860] 'process raft request'  (duration: 269.965985ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:33.051915Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.337689ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/default/kubernetes\" ","response":"range_response_count:1 size:481"}
{"level":"info","ts":"2026-04-23T14:24:33.051943Z","caller":"traceutil/trace.go:171","msg":"trace[2739792] range","detail":"{range_begin:/registry/runtimeclasses/; range_end:/registry/runtimeclasses0; response_count:0; response_revision:1851; }","duration":"258.927133ms","start":"2026-04-23T14:24:32.793004Z","end":"2026-04-23T14:24:33.051931Z","steps":["trace[2739792] 'agreement among raft nodes before linearized reading'  (duration: 258.815ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:33.052039Z","caller":"traceutil/trace.go:171","msg":"trace[872137315] range","detail":"{range_begin:/registry/endpointslices/default/kubernetes; range_end:; response_count:1; response_revision:1851; }","duration":"269.512073ms","start":"2026-04-23T14:24:32.782491Z","end":"2026-04-23T14:24:33.052003Z","steps":["trace[872137315] 'agreement among raft nodes before linearized reading'  (duration: 269.231735ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:33.514276Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.0793ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"warn","ts":"2026-04-23T14:24:33.514307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.255204ms","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-04-23T14:24:33.514367Z","caller":"traceutil/trace.go:171","msg":"trace[594290912] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1851; }","duration":"203.220513ms","start":"2026-04-23T14:24:33.311128Z","end":"2026-04-23T14:24:33.514349Z","steps":["trace[594290912] 'count revisions from in-memory index tree'  (duration: 203.000198ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:33.514446Z","caller":"traceutil/trace.go:171","msg":"trace[775808315] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1851; }","duration":"276.45004ms","start":"2026-04-23T14:24:33.237961Z","end":"2026-04-23T14:24:33.514411Z","steps":["trace[775808315] 'range keys from in-memory index tree'  (duration: 276.011098ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:33.677467Z","caller":"traceutil/trace.go:171","msg":"trace[1565590232] transaction","detail":"{read_only:false; response_revision:1852; number_of_response:1; }","duration":"158.194157ms","start":"2026-04-23T14:24:33.51925Z","end":"2026-04-23T14:24:33.677444Z","steps":["trace[1565590232] 'process raft request'  (duration: 158.041172ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:35.198475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.434048ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"warn","ts":"2026-04-23T14:24:35.198669Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.301634ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-04-23T14:24:35.198582Z","caller":"traceutil/trace.go:171","msg":"trace[1525526065] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1855; }","duration":"143.542881ms","start":"2026-04-23T14:24:35.055015Z","end":"2026-04-23T14:24:35.198558Z","steps":["trace[1525526065] 'range keys from in-memory index tree'  (duration: 143.242652ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:35.198765Z","caller":"traceutil/trace.go:171","msg":"trace[365279579] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1855; }","duration":"143.448048ms","start":"2026-04-23T14:24:35.055301Z","end":"2026-04-23T14:24:35.198749Z","steps":["trace[365279579] 'range keys from in-memory index tree'  (duration: 143.019526ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:36.46508Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"365.573478ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440415 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:1850 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:36.465549Z","caller":"traceutil/trace.go:171","msg":"trace[1633162905] linearizableReadLoop","detail":"{readStateIndex:1949; appliedIndex:1948; }","duration":"783.102316ms","start":"2026-04-23T14:24:35.682433Z","end":"2026-04-23T14:24:36.465535Z","steps":["trace[1633162905] 'read index received'  (duration: 416.969223ms)","trace[1633162905] 'applied index is now lower than readState.Index'  (duration: 366.131853ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:36.465575Z","caller":"traceutil/trace.go:171","msg":"trace[70378149] transaction","detail":"{read_only:false; response_revision:1857; number_of_response:1; }","duration":"1.261932795s","start":"2026-04-23T14:24:35.203608Z","end":"2026-04-23T14:24:36.465541Z","steps":["trace[70378149] 'process raft request'  (duration: 895.684788ms)","trace[70378149] 'compare'  (duration: 364.982041ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:36.465693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"783.25737ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"warn","ts":"2026-04-23T14:24:36.46572Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:35.203597Z","time spent":"1.262054398s","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:1850 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-04-23T14:24:36.465732Z","caller":"traceutil/trace.go:171","msg":"trace[833636679] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1857; }","duration":"783.344243ms","start":"2026-04-23T14:24:35.682379Z","end":"2026-04-23T14:24:36.465723Z","steps":["trace[833636679] 'agreement among raft nodes before linearized reading'  (duration: 783.192108ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:36.465758Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:35.682358Z","time spent":"783.395365ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-04-23T14:24:36.529819Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"354.249595ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:36.529838Z","caller":"traceutil/trace.go:171","msg":"trace[50832276] transaction","detail":"{read_only:false; response_revision:1858; number_of_response:1; }","duration":"656.443055ms","start":"2026-04-23T14:24:35.873342Z","end":"2026-04-23T14:24:36.529785Z","steps":["trace[50832276] 'process raft request'  (duration: 656.247939ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:36.5299Z","caller":"traceutil/trace.go:171","msg":"trace[541385207] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1858; }","duration":"354.3869ms","start":"2026-04-23T14:24:36.175496Z","end":"2026-04-23T14:24:36.529883Z","steps":["trace[541385207] 'agreement among raft nodes before linearized reading'  (duration: 354.236975ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:36.529944Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.175464Z","time spent":"354.470552ms","remote":"127.0.0.1:53800","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-04-23T14:24:36.530024Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:35.873305Z","time spent":"656.61842ms","remote":"127.0.0.1:54042","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:1853 > 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-04-23T14:24:36.530223Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"261.66593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-04-23T14:24:36.530393Z","caller":"traceutil/trace.go:171","msg":"trace[1379012477] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1858; }","duration":"261.904207ms","start":"2026-04-23T14:24:36.268446Z","end":"2026-04-23T14:24:36.530351Z","steps":["trace[1379012477] 'agreement among raft nodes before linearized reading'  (duration: 261.337471ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.03138Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":3415872267615440419,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-04-23T14:24:37.255927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.045348ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440418 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:1852 > 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\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:37.256036Z","caller":"traceutil/trace.go:171","msg":"trace[358824718] transaction","detail":"{read_only:false; response_revision:1859; number_of_response:1; }","duration":"786.020599ms","start":"2026-04-23T14:24:36.469995Z","end":"2026-04-23T14:24:37.256015Z","steps":["trace[358824718] 'process raft request'  (duration: 655.812387ms)","trace[358824718] 'compare'  (duration: 129.649877ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:37.256104Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.469978Z","time spent":"786.096111ms","remote":"127.0.0.1:54042","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:1852 > 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-04-23T14:24:37.307635Z","caller":"traceutil/trace.go:171","msg":"trace[1144689117] linearizableReadLoop","detail":"{readStateIndex:1953; appliedIndex:1950; }","duration":"776.662664ms","start":"2026-04-23T14:24:36.530944Z","end":"2026-04-23T14:24:37.307607Z","steps":["trace[1144689117] 'read index received'  (duration: 595.086375ms)","trace[1144689117] 'applied index is now lower than readState.Index'  (duration: 181.575219ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:37.307722Z","caller":"traceutil/trace.go:171","msg":"trace[1815808095] transaction","detail":"{read_only:false; response_revision:1860; number_of_response:1; }","duration":"771.843788ms","start":"2026-04-23T14:24:36.535826Z","end":"2026-04-23T14:24:37.30767Z","steps":["trace[1815808095] 'process raft request'  (duration: 771.531929ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:37.307806Z","caller":"traceutil/trace.go:171","msg":"trace[63920075] transaction","detail":"{read_only:false; response_revision:1861; number_of_response:1; }","duration":"305.105602ms","start":"2026-04-23T14:24:37.002687Z","end":"2026-04-23T14:24:37.307793Z","steps":["trace[63920075] 'process raft request'  (duration: 304.848655ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.307918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:37.002667Z","time spent":"305.178454ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":892,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv.18a902800eb140f3\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv.18a902800eb140f3\" value_size:788 lease:3415872267615440088 >> failure:<>"}
{"level":"warn","ts":"2026-04-23T14:24:37.308079Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"777.121977ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:37.308126Z","caller":"traceutil/trace.go:171","msg":"trace[1308687706] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1861; }","duration":"777.208159ms","start":"2026-04-23T14:24:36.530906Z","end":"2026-04-23T14:24:37.308114Z","steps":["trace[1308687706] 'agreement among raft nodes before linearized reading'  (duration: 777.131967ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.308155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.83092ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/default/test-pvc.18a9027df72d8f24\" ","response":"range_response_count:1 size:896"}
{"level":"warn","ts":"2026-04-23T14:24:37.308149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.535791Z","time spent":"772.019273ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:1854 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:37.308187Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.530888Z","time spent":"777.289691ms","remote":"127.0.0.1:53810","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-04-23T14:24:37.308206Z","caller":"traceutil/trace.go:171","msg":"trace[1584360127] range","detail":"{range_begin:/registry/events/default/test-pvc.18a9027df72d8f24; range_end:; response_count:1; response_revision:1861; }","duration":"392.930312ms","start":"2026-04-23T14:24:36.915263Z","end":"2026-04-23T14:24:37.308193Z","steps":["trace[1584360127] 'agreement among raft nodes before linearized reading'  (duration: 392.759257ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.308247Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.915237Z","time spent":"393.002545ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":1,"response size":919,"request content":"key:\"/registry/events/default/test-pvc.18a9027df72d8f24\" "}
{"level":"warn","ts":"2026-04-23T14:24:37.308551Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"425.404383ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-04-23T14:24:37.308609Z","caller":"traceutil/trace.go:171","msg":"trace[1005298483] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1861; }","duration":"425.507507ms","start":"2026-04-23T14:24:36.883092Z","end":"2026-04-23T14:24:37.3086Z","steps":["trace[1005298483] 'agreement among raft nodes before linearized reading'  (duration: 424.796757ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.308659Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:36.88307Z","time spent":"425.560267ms","remote":"127.0.0.1:54042","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":"info","ts":"2026-04-23T14:24:37.678447Z","caller":"traceutil/trace.go:171","msg":"trace[1523389712] transaction","detail":"{read_only:false; response_revision:1862; number_of_response:1; }","duration":"368.187281ms","start":"2026-04-23T14:24:37.310233Z","end":"2026-04-23T14:24:37.67842Z","steps":["trace[1523389712] 'process raft request'  (duration: 368.032186ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.678686Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:37.310213Z","time spent":"368.394016ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":881,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/default/test-pvc.18a9027df72d8f24\" mod_revision:1820 > success:<request_put:<key:\"/registry/events/default/test-pvc.18a9027df72d8f24\" value_size:813 lease:3415872267615440088 >> failure:<request_range:<key:\"/registry/events/default/test-pvc.18a9027df72d8f24\" > >"}
{"level":"info","ts":"2026-04-23T14:24:37.762824Z","caller":"traceutil/trace.go:171","msg":"trace[743795447] transaction","detail":"{read_only:false; response_revision:1863; number_of_response:1; }","duration":"450.183525ms","start":"2026-04-23T14:24:37.312617Z","end":"2026-04-23T14:24:37.7628Z","steps":["trace[743795447] 'process raft request'  (duration: 450.00526ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.763006Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:37.3126Z","time spent":"450.297938ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:1856 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-04-23T14:24:37.763107Z","caller":"traceutil/trace.go:171","msg":"trace[54413354] linearizableReadLoop","detail":"{readStateIndex:1956; appliedIndex:1953; }","duration":"447.161519ms","start":"2026-04-23T14:24:37.315884Z","end":"2026-04-23T14:24:37.763046Z","steps":["trace[54413354] 'read index received'  (duration: 362.492508ms)","trace[54413354] 'applied index is now lower than readState.Index'  (duration: 84.667211ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:37.763283Z","caller":"traceutil/trace.go:171","msg":"trace[1998088889] transaction","detail":"{read_only:false; response_revision:1864; number_of_response:1; }","duration":"449.355982ms","start":"2026-04-23T14:24:37.313907Z","end":"2026-04-23T14:24:37.763263Z","steps":["trace[1998088889] 'process raft request'  (duration: 448.840218ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.763355Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:37.313891Z","time spent":"449.428184ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:1855 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:37.763245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"447.350856ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:37.763849Z","caller":"traceutil/trace.go:171","msg":"trace[2100897249] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1864; }","duration":"447.973463ms","start":"2026-04-23T14:24:37.315858Z","end":"2026-04-23T14:24:37.763831Z","steps":["trace[2100897249] 'agreement among raft nodes before linearized reading'  (duration: 447.313614ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:37.763906Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:37.315847Z","time spent":"448.043845ms","remote":"127.0.0.1:53800","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-04-23T14:24:38.030995Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.649201ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440427 > lease_revoke:<id:2f679dbab5538d86>","response":"size:28"}
{"level":"info","ts":"2026-04-23T14:24:38.031083Z","caller":"traceutil/trace.go:171","msg":"trace[1976727913] linearizableReadLoop","detail":"{readStateIndex:1957; appliedIndex:1956; }","duration":"266.219179ms","start":"2026-04-23T14:24:37.76485Z","end":"2026-04-23T14:24:38.031069Z","steps":["trace[1976727913] 'read index received'  (duration: 59.394914ms)","trace[1976727913] 'applied index is now lower than readState.Index'  (duration: 206.823175ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:38.031139Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"266.281481ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:38.031157Z","caller":"traceutil/trace.go:171","msg":"trace[1935562362] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1864; }","duration":"266.345802ms","start":"2026-04-23T14:24:37.764804Z","end":"2026-04-23T14:24:38.03115Z","steps":["trace[1935562362] 'agreement among raft nodes before linearized reading'  (duration: 266.297571ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:38.659406Z","caller":"traceutil/trace.go:171","msg":"trace[1371189069] transaction","detail":"{read_only:false; response_revision:1866; number_of_response:1; }","duration":"128.216435ms","start":"2026-04-23T14:24:38.531161Z","end":"2026-04-23T14:24:38.659377Z","steps":["trace[1371189069] 'process raft request'  (duration: 43.901244ms)","trace[1371189069] 'compare'  (duration: 83.870429ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:38.890386Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.459096ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440435 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:1858 > 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\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:38.890643Z","caller":"traceutil/trace.go:171","msg":"trace[684822972] transaction","detail":"{read_only:false; response_revision:1868; number_of_response:1; }","duration":"183.781452ms","start":"2026-04-23T14:24:38.706842Z","end":"2026-04-23T14:24:38.890623Z","steps":["trace[684822972] 'process raft request'  (duration: 183.7186ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:38.890675Z","caller":"traceutil/trace.go:171","msg":"trace[236452484] linearizableReadLoop","detail":"{readStateIndex:1960; appliedIndex:1959; }","duration":"276.240754ms","start":"2026-04-23T14:24:38.614414Z","end":"2026-04-23T14:24:38.890655Z","steps":["trace[236452484] 'read index received'  (duration: 149.451729ms)","trace[236452484] 'applied index is now lower than readState.Index'  (duration: 126.787225ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:38.890691Z","caller":"traceutil/trace.go:171","msg":"trace[1307400675] transaction","detail":"{read_only:false; response_revision:1867; number_of_response:1; }","duration":"355.728998ms","start":"2026-04-23T14:24:38.534932Z","end":"2026-04-23T14:24:38.890661Z","steps":["trace[1307400675] 'process raft request'  (duration: 228.918022ms)","trace[1307400675] 'compare'  (duration: 126.275601ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:38.89084Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:38.534907Z","time spent":"355.856031ms","remote":"127.0.0.1:54042","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:1858 > 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-04-23T14:24:38.890848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.425079ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:38.891037Z","caller":"traceutil/trace.go:171","msg":"trace[1628413479] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1868; }","duration":"276.648465ms","start":"2026-04-23T14:24:38.614376Z","end":"2026-04-23T14:24:38.891025Z","steps":["trace[1628413479] 'agreement among raft nodes before linearized reading'  (duration: 276.405808ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.129892Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.379595ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440439 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/events/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv.18a90280744add7b\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv.18a90280744add7b\" value_size:732 lease:3415872267615440088 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:39.130075Z","caller":"traceutil/trace.go:171","msg":"trace[1079249748] linearizableReadLoop","detail":"{readStateIndex:1962; appliedIndex:1961; }","duration":"234.071577ms","start":"2026-04-23T14:24:38.895887Z","end":"2026-04-23T14:24:39.129958Z","steps":["trace[1079249748] 'read index received'  (duration: 114.506907ms)","trace[1079249748] 'applied index is now lower than readState.Index'  (duration: 119.56275ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:39.130158Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.262863ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:39.130184Z","caller":"traceutil/trace.go:171","msg":"trace[1804796167] range","detail":"{range_begin:/registry/resourcequotas/kube-system/; range_end:/registry/resourcequotas/kube-system0; response_count:0; response_revision:1869; }","duration":"234.323405ms","start":"2026-04-23T14:24:38.895853Z","end":"2026-04-23T14:24:39.130176Z","steps":["trace[1804796167] 'agreement among raft nodes before linearized reading'  (duration: 234.254623ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:39.130301Z","caller":"traceutil/trace.go:171","msg":"trace[952889877] transaction","detail":"{read_only:false; response_revision:1869; number_of_response:1; }","duration":"235.696563ms","start":"2026-04-23T14:24:38.89458Z","end":"2026-04-23T14:24:39.130277Z","steps":["trace[952889877] 'process raft request'  (duration: 115.875876ms)","trace[952889877] 'compare'  (duration: 119.18385ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:39.206475Z","caller":"traceutil/trace.go:171","msg":"trace[1051342573] transaction","detail":"{read_only:false; response_revision:1870; number_of_response:1; }","duration":"120.307712ms","start":"2026-04-23T14:24:39.086131Z","end":"2026-04-23T14:24:39.206439Z","steps":["trace[1051342573] 'process raft request'  (duration: 120.113087ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.812938Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"408.930616ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:39.813073Z","caller":"traceutil/trace.go:171","msg":"trace[1333847321] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1870; }","duration":"409.06161ms","start":"2026-04-23T14:24:39.403982Z","end":"2026-04-23T14:24:39.813044Z","steps":["trace[1333847321] 'range keys from in-memory index tree'  (duration: 408.910806ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.813565Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"522.131816ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440442 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" mod_revision:0 > success:<request_put:<key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" value_size:406 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:24:39.813655Z","caller":"traceutil/trace.go:171","msg":"trace[1600649153] linearizableReadLoop","detail":"{readStateIndex:1964; appliedIndex:1962; }","duration":"637.536347ms","start":"2026-04-23T14:24:39.176103Z","end":"2026-04-23T14:24:39.813639Z","steps":["trace[1600649153] 'read index received'  (duration: 30.081732ms)","trace[1600649153] 'applied index is now lower than readState.Index'  (duration: 607.453455ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:39.813721Z","caller":"traceutil/trace.go:171","msg":"trace[514740666] transaction","detail":"{read_only:false; response_revision:1871; number_of_response:1; }","duration":"682.176073ms","start":"2026-04-23T14:24:39.131532Z","end":"2026-04-23T14:24:39.813708Z","steps":["trace[514740666] 'process raft request'  (duration: 159.733669ms)","trace[514740666] 'compare'  (duration: 521.441176ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:24:39.81376Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.131518Z","time spent":"682.223765ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":459,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" mod_revision:0 > success:<request_put:<key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" value_size:406 >> failure:<>"}
{"level":"warn","ts":"2026-04-23T14:24:39.814032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"637.933069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:39.814053Z","caller":"traceutil/trace.go:171","msg":"trace[1196576343] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1871; }","duration":"637.993001ms","start":"2026-04-23T14:24:39.176054Z","end":"2026-04-23T14:24:39.814047Z","steps":["trace[1196576343] 'agreement among raft nodes before linearized reading'  (duration: 637.928559ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.814077Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.175981Z","time spent":"638.091244ms","remote":"127.0.0.1:53810","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-04-23T14:24:39.814302Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"554.34747ms","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-04-23T14:24:39.814319Z","caller":"traceutil/trace.go:171","msg":"trace[146840462] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1871; }","duration":"554.408011ms","start":"2026-04-23T14:24:39.259907Z","end":"2026-04-23T14:24:39.814315Z","steps":["trace[146840462] 'agreement among raft nodes before linearized reading'  (duration: 554.320289ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.814338Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.259884Z","time spent":"554.449133ms","remote":"127.0.0.1:54042","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":"warn","ts":"2026-04-23T14:24:39.814919Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"501.221963ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-04-23T14:24:39.81494Z","caller":"traceutil/trace.go:171","msg":"trace[1441389752] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1871; }","duration":"501.283575ms","start":"2026-04-23T14:24:39.313649Z","end":"2026-04-23T14:24:39.814933Z","steps":["trace[1441389752] 'agreement among raft nodes before linearized reading'  (duration: 501.234263ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:39.814954Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.313626Z","time spent":"501.324556ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-04-23T14:24:40.523713Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":3415872267615440445,"retry-timeout":"500ms"}
{"level":"info","ts":"2026-04-23T14:24:40.632693Z","caller":"traceutil/trace.go:171","msg":"trace[21567339] transaction","detail":"{read_only:false; response_revision:1872; number_of_response:1; }","duration":"811.660287ms","start":"2026-04-23T14:24:39.821002Z","end":"2026-04-23T14:24:40.632662Z","steps":["trace[21567339] 'process raft request'  (duration: 811.459891ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.632904Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.820987Z","time spent":"811.828112ms","remote":"127.0.0.1:54042","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:1860 > 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-04-23T14:24:40.793938Z","caller":"traceutil/trace.go:171","msg":"trace[1704575317] transaction","detail":"{read_only:false; response_revision:1874; number_of_response:1; }","duration":"972.251951ms","start":"2026-04-23T14:24:39.821667Z","end":"2026-04-23T14:24:40.793919Z","steps":["trace[1704575317] 'process raft request'  (duration: 972.185499ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:40.793988Z","caller":"traceutil/trace.go:171","msg":"trace[338175378] transaction","detail":"{read_only:false; response_revision:1873; number_of_response:1; }","duration":"972.439636ms","start":"2026-04-23T14:24:39.821511Z","end":"2026-04-23T14:24:40.79395Z","steps":["trace[338175378] 'process raft request'  (duration: 972.204549ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.79405Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.821661Z","time spent":"972.341093ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":773,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/kube-system/rbd-csi-ceph-com.18a90280b6b0d639\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/rbd-csi-ceph-com.18a90280b6b0d639\" value_size:693 lease:3415872267615440088 >> failure:<>"}
{"level":"warn","ts":"2026-04-23T14:24:40.794151Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.821491Z","time spent":"972.57573ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:1863 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-04-23T14:24:40.79431Z","caller":"traceutil/trace.go:171","msg":"trace[1170935367] linearizableReadLoop","detail":"{readStateIndex:1971; appliedIndex:1964; }","duration":"771.392614ms","start":"2026-04-23T14:24:40.022897Z","end":"2026-04-23T14:24:40.79429Z","steps":["trace[1170935367] 'read index received'  (duration: 609.609427ms)","trace[1170935367] 'applied index is now lower than readState.Index'  (duration: 161.781797ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:24:40.794364Z","caller":"traceutil/trace.go:171","msg":"trace[1084581424] transaction","detail":"{read_only:false; response_revision:1877; number_of_response:1; }","duration":"971.242621ms","start":"2026-04-23T14:24:39.82311Z","end":"2026-04-23T14:24:40.794353Z","steps":["trace[1084581424] 'process raft request'  (duration: 971.041005ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:40.794379Z","caller":"traceutil/trace.go:171","msg":"trace[132744657] transaction","detail":"{read_only:false; response_revision:1878; number_of_response:1; }","duration":"770.323514ms","start":"2026-04-23T14:24:40.024038Z","end":"2026-04-23T14:24:40.794361Z","steps":["trace[132744657] 'process raft request'  (duration: 770.194821ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.794441Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.823103Z","time spent":"971.298552ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":459,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" mod_revision:1871 > success:<request_put:<key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" value_size:406 >> failure:<request_range:<key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" > >"}
{"level":"warn","ts":"2026-04-23T14:24:40.794473Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:40.02402Z","time spent":"770.418677ms","remote":"127.0.0.1:53868","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":838,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/default/test-pvc.18a90280c2bfe6ba\" mod_revision:0 > success:<request_put:<key:\"/registry/events/default/test-pvc.18a90280c2bfe6ba\" value_size:770 lease:3415872267615440088 >> failure:<>"}
{"level":"info","ts":"2026-04-23T14:24:40.794501Z","caller":"traceutil/trace.go:171","msg":"trace[1715358422] transaction","detail":"{read_only:false; response_revision:1876; number_of_response:1; }","duration":"971.56002ms","start":"2026-04-23T14:24:39.822933Z","end":"2026-04-23T14:24:40.794493Z","steps":["trace[1715358422] 'process raft request'  (duration: 971.142968ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.794512Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"771.60662ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/kube-system/csi-rbd-secret\" ","response":"range_response_count:1 size:880"}
{"level":"warn","ts":"2026-04-23T14:24:40.794536Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.822926Z","time spent":"971.589751ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":475,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:1859 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:409 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-04-23T14:24:40.794547Z","caller":"traceutil/trace.go:171","msg":"trace[1038681087] range","detail":"{range_begin:/registry/secrets/kube-system/csi-rbd-secret; range_end:; response_count:1; response_revision:1878; }","duration":"771.691943ms","start":"2026-04-23T14:24:40.022845Z","end":"2026-04-23T14:24:40.794537Z","steps":["trace[1038681087] 'agreement among raft nodes before linearized reading'  (duration: 771.56223ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.794587Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:40.022819Z","time spent":"771.760095ms","remote":"127.0.0.1:53898","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":903,"request content":"key:\"/registry/secrets/kube-system/csi-rbd-secret\" "}
{"level":"warn","ts":"2026-04-23T14:24:40.794682Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"618.609943ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:24:40.794774Z","caller":"traceutil/trace.go:171","msg":"trace[1428493547] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1878; }","duration":"618.743886ms","start":"2026-04-23T14:24:40.176013Z","end":"2026-04-23T14:24:40.794757Z","steps":["trace[1428493547] 'agreement among raft nodes before linearized reading'  (duration: 618.622793ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.794798Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.103133ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-04-23T14:24:40.794826Z","caller":"traceutil/trace.go:171","msg":"trace[1253496448] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1878; }","duration":"274.175585ms","start":"2026-04-23T14:24:40.520638Z","end":"2026-04-23T14:24:40.794814Z","steps":["trace[1253496448] 'agreement among raft nodes before linearized reading'  (duration: 274.104753ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:24:40.794331Z","caller":"traceutil/trace.go:171","msg":"trace[1096799304] transaction","detail":"{read_only:false; response_revision:1875; number_of_response:1; }","duration":"972.441466ms","start":"2026-04-23T14:24:39.821847Z","end":"2026-04-23T14:24:40.794289Z","steps":["trace[1096799304] 'process raft request'  (duration: 972.041345ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:24:40.794829Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:40.175949Z","time spent":"618.86793ms","remote":"127.0.0.1:53800","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-04-23T14:24:40.795041Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:24:39.821829Z","time spent":"973.108355ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:1864 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-04-23T14:25:04.973377Z","caller":"traceutil/trace.go:171","msg":"trace[277127272] transaction","detail":"{read_only:false; response_revision:2036; number_of_response:1; }","duration":"132.158589ms","start":"2026-04-23T14:25:04.841178Z","end":"2026-04-23T14:25:04.973337Z","steps":["trace[277127272] 'process raft request'  (duration: 131.873541ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:05.470247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.654134ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440806 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2026 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:25:05.470385Z","caller":"traceutil/trace.go:171","msg":"trace[1968117527] transaction","detail":"{read_only:false; response_revision:2037; number_of_response:1; }","duration":"492.656221ms","start":"2026-04-23T14:25:04.977701Z","end":"2026-04-23T14:25:05.470357Z","steps":["trace[1968117527] 'process raft request'  (duration: 315.776291ms)","trace[1968117527] 'compare'  (duration: 176.52162ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:25:05.470486Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:04.977677Z","time spent":"492.749073ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2026 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-04-23T14:25:05.752505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.248056ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440807 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:2027 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:25:05.752769Z","caller":"traceutil/trace.go:171","msg":"trace[1140862189] transaction","detail":"{read_only:false; response_revision:2038; number_of_response:1; }","duration":"774.322552ms","start":"2026-04-23T14:25:04.978409Z","end":"2026-04-23T14:25:05.752731Z","steps":["trace[1140862189] 'process raft request'  (duration: 599.686805ms)","trace[1140862189] 'compare'  (duration: 173.982598ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:25:05.752855Z","caller":"traceutil/trace.go:171","msg":"trace[565963234] linearizableReadLoop","detail":"{readStateIndex:2139; appliedIndex:2135; }","duration":"318.594941ms","start":"2026-04-23T14:25:05.434241Z","end":"2026-04-23T14:25:05.752836Z","steps":["trace[565963234] 'read index received'  (duration: 143.908392ms)","trace[565963234] 'applied index is now lower than readState.Index'  (duration: 174.685399ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:25:05.752943Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:04.978382Z","time spent":"774.475725ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:2027 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-04-23T14:25:05.753417Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"319.166507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/test-pv\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-23T14:25:05.753439Z","caller":"traceutil/trace.go:171","msg":"trace[1468467568] transaction","detail":"{read_only:false; response_revision:2040; number_of_response:1; }","duration":"773.045475ms","start":"2026-04-23T14:25:04.980361Z","end":"2026-04-23T14:25:05.753407Z","steps":["trace[1468467568] 'process raft request'  (duration: 772.331705ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:25:05.753497Z","caller":"traceutil/trace.go:171","msg":"trace[979105951] range","detail":"{range_begin:/registry/persistentvolumes/test-pv; range_end:; response_count:0; response_revision:2041; }","duration":"319.27344ms","start":"2026-04-23T14:25:05.434206Z","end":"2026-04-23T14:25:05.753479Z","steps":["trace[979105951] 'agreement among raft nodes before linearized reading'  (duration: 319.172397ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:05.753543Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:05.434189Z","time spent":"319.342482ms","remote":"127.0.0.1:53942","response type":"/etcdserverpb.KV/Range","request count":0,"request size":37,"response count":0,"response size":28,"request content":"key:\"/registry/persistentvolumes/test-pv\" "}
{"level":"info","ts":"2026-04-23T14:25:05.753524Z","caller":"traceutil/trace.go:171","msg":"trace[975370465] transaction","detail":"{read_only:false; response_revision:2041; number_of_response:1; }","duration":"744.72175ms","start":"2026-04-23T14:25:05.008758Z","end":"2026-04-23T14:25:05.753479Z","steps":["trace[975370465] 'process raft request'  (duration: 744.01612ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:05.753551Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.983436ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:526"}
{"level":"warn","ts":"2026-04-23T14:25:05.753604Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:04.980333Z","time spent":"773.184659ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:2029 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-04-23T14:25:05.753615Z","caller":"traceutil/trace.go:171","msg":"trace[168863951] range","detail":"{range_begin:/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2041; }","duration":"143.081079ms","start":"2026-04-23T14:25:05.610509Z","end":"2026-04-23T14:25:05.75359Z","steps":["trace[168863951] 'agreement among raft nodes before linearized reading'  (duration: 142.905924ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:05.753682Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:05.008737Z","time spent":"744.861683ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:2030 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:458 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"info","ts":"2026-04-23T14:25:05.753152Z","caller":"traceutil/trace.go:171","msg":"trace[10070763] transaction","detail":"{read_only:false; response_revision:2039; number_of_response:1; }","duration":"773.562039ms","start":"2026-04-23T14:25:04.979577Z","end":"2026-04-23T14:25:05.753139Z","steps":["trace[10070763] 'process raft request'  (duration: 773.036165ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:05.754256Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:04.979561Z","time spent":"774.638249ms","remote":"127.0.0.1:54042","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:2028 > 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":"warn","ts":"2026-04-23T14:25:06.141351Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.769042ms","expected-duration":"100ms","prefix":"","request":"header:<ID:3415872267615440814 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" mod_revision:2014 > success:<request_put:<key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" value_size:433 >> failure:<request_range:<key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-23T14:25:06.141461Z","caller":"traceutil/trace.go:171","msg":"trace[388824641] linearizableReadLoop","detail":"{readStateIndex:2140; appliedIndex:2139; }","duration":"280.111016ms","start":"2026-04-23T14:25:05.861332Z","end":"2026-04-23T14:25:06.141443Z","steps":["trace[388824641] 'read index received'  (duration: 10.165279ms)","trace[388824641] 'applied index is now lower than readState.Index'  (duration: 269.944047ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:25:06.141738Z","caller":"traceutil/trace.go:171","msg":"trace[1711819639] transaction","detail":"{read_only:false; response_revision:2042; number_of_response:1; }","duration":"383.26451ms","start":"2026-04-23T14:25:05.758441Z","end":"2026-04-23T14:25:06.141705Z","steps":["trace[1711819639] 'process raft request'  (duration: 113.046025ms)","trace[1711819639] 'compare'  (duration: 269.442282ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:25:06.141837Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.492198ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:474"}
{"level":"warn","ts":"2026-04-23T14:25:06.141879Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-23T14:25:05.758423Z","time spent":"383.387863ms","remote":"127.0.0.1:54042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":511,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" mod_revision:2014 > success:<request_put:<key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" value_size:433 >> failure:<request_range:<key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" > >"}
{"level":"info","ts":"2026-04-23T14:25:06.141893Z","caller":"traceutil/trace.go:171","msg":"trace[1052528335] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2042; }","duration":"280.591791ms","start":"2026-04-23T14:25:05.861288Z","end":"2026-04-23T14:25:06.14188Z","steps":["trace[1052528335] 'agreement among raft nodes before linearized reading'  (duration: 280.413356ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:06.14204Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.158706ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:532"}
{"level":"info","ts":"2026-04-23T14:25:06.142151Z","caller":"traceutil/trace.go:171","msg":"trace[1269207042] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:2042; }","duration":"211.320061ms","start":"2026-04-23T14:25:05.930803Z","end":"2026-04-23T14:25:06.142123Z","steps":["trace[1269207042] 'agreement among raft nodes before linearized reading'  (duration: 210.901449ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:25:13.942009Z","caller":"traceutil/trace.go:171","msg":"trace[928388083] transaction","detail":"{read_only:false; response_revision:2084; number_of_response:1; }","duration":"122.298009ms","start":"2026-04-23T14:25:13.819677Z","end":"2026-04-23T14:25:13.941975Z","steps":["trace[928388083] 'process raft request'  (duration: 121.928338ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:25:15.7005Z","caller":"traceutil/trace.go:171","msg":"trace[374502435] linearizableReadLoop","detail":"{readStateIndex:2191; appliedIndex:2190; }","duration":"113.21808ms","start":"2026-04-23T14:25:15.587246Z","end":"2026-04-23T14:25:15.700464Z","steps":["trace[374502435] 'read index received'  (duration: 112.953533ms)","trace[374502435] 'applied index is now lower than readState.Index'  (duration: 263.387µs)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:25:15.700629Z","caller":"traceutil/trace.go:171","msg":"trace[254609528] transaction","detail":"{read_only:false; response_revision:2090; number_of_response:1; }","duration":"159.97088ms","start":"2026-04-23T14:25:15.540623Z","end":"2026-04-23T14:25:15.700594Z","steps":["trace[254609528] 'process raft request'  (duration: 159.63224ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:15.700726Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.464218ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:job-controller\" ","response":"range_response_count:1 size:780"}
{"level":"info","ts":"2026-04-23T14:25:15.700904Z","caller":"traceutil/trace.go:171","msg":"trace[1858571932] range","detail":"{range_begin:/registry/clusterroles/system:controller:job-controller; range_end:; response_count:1; response_revision:2090; }","duration":"113.640982ms","start":"2026-04-23T14:25:15.587196Z","end":"2026-04-23T14:25:15.700837Z","steps":["trace[1858571932] 'agreement among raft nodes before linearized reading'  (duration: 113.454637ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:25:31.393812Z","caller":"traceutil/trace.go:171","msg":"trace[915650455] linearizableReadLoop","detail":"{readStateIndex:2266; appliedIndex:2265; }","duration":"112.620784ms","start":"2026-04-23T14:25:31.281158Z","end":"2026-04-23T14:25:31.393779Z","steps":["trace[915650455] 'read index received'  (duration: 24.531139ms)","trace[915650455] 'applied index is now lower than readState.Index'  (duration: 88.088325ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:25:31.393961Z","caller":"traceutil/trace.go:171","msg":"trace[395787627] transaction","detail":"{read_only:false; response_revision:2162; number_of_response:1; }","duration":"147.487955ms","start":"2026-04-23T14:25:31.24643Z","end":"2026-04-23T14:25:31.393918Z","steps":["trace[395787627] 'process raft request'  (duration: 59.311777ms)","trace[395787627] 'get key's previous created_revision and leaseID' {req_type:put; key:/registry/leases/kube-system/rbd-csi-ceph-com; req_size:455; } (duration: 87.8821ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-23T14:25:31.394111Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.929432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv\" ","response":"range_response_count:1 size:13724"}
{"level":"info","ts":"2026-04-23T14:25:31.394208Z","caller":"traceutil/trace.go:171","msg":"trace[1887061192] range","detail":"{range_begin:/registry/pods/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-kt4qv; range_end:; response_count:1; response_revision:2162; }","duration":"113.071787ms","start":"2026-04-23T14:25:31.281114Z","end":"2026-04-23T14:25:31.394186Z","steps":["trace[1887061192] 'agreement among raft nodes before linearized reading'  (duration: 112.791729ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-23T14:25:31.394175Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.701918ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-operator-869df985b8-pqlz5\" ","response":"range_response_count:1 size:4694"}
{"level":"info","ts":"2026-04-23T14:25:31.394277Z","caller":"traceutil/trace.go:171","msg":"trace[645845599] range","detail":"{range_begin:/registry/pods/kube-system/cilium-operator-869df985b8-pqlz5; range_end:; response_count:1; response_revision:2162; }","duration":"104.842232ms","start":"2026-04-23T14:25:31.289412Z","end":"2026-04-23T14:25:31.394254Z","steps":["trace[645845599] 'agreement among raft nodes before linearized reading'  (duration: 104.578855ms)"],"step_count":1}
{"level":"info","ts":"2026-04-23T14:25:46.563567Z","caller":"traceutil/trace.go:171","msg":"trace[217241706] transaction","detail":"{read_only:false; response_revision:2232; number_of_response:1; }","duration":"102.762173ms","start":"2026-04-23T14:25:46.460787Z","end":"2026-04-23T14:25:46.563549Z","steps":["trace[217241706] 'process raft request'  (duration: 71.322989ms)","trace[217241706] 'compare'  (duration: 31.29144ms)"],"step_count":2}
{"level":"info","ts":"2026-04-23T14:25:46.563745Z","caller":"traceutil/trace.go:171","msg":"trace[1908148468] transaction","detail":"{read_only:false; response_revision:2233; number_of_response:1; }","duration":"102.144186ms","start":"2026-04-23T14:25:46.461584Z","end":"2026-04-23T14:25:46.563728Z","steps":["trace[1908148468] 'process raft request'  (duration: 101.898679ms)"],"step_count":1}