{"level":"warn","ts":"2026-02-25T15:00:49.427501Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-02-25T15:00:49.427583Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.149: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.149:2380","--initial-cluster=instance=https://199.204.45.149:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.149:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.149: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-02-25T15:00:49.427651Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-02-25T15:00:49.427663Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.149:2380"]}
{"level":"info","ts":"2026-02-25T15:00:49.42768Z","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-02-25T15:00:49.428347Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.149:2379"]}
{"level":"info","ts":"2026-02-25T15:00:49.428422Z","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.149:2380"],"listen-peer-urls":["https://199.204.45.149:2380"],"advertise-client-urls":["https://199.204.45.149:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.149:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.149: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-02-25T15:00:49.432978Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.360847ms"}
{"level":"info","ts":"2026-02-25T15:00:49.440131Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b1b675f124322401","cluster-id":"913dfbf24a38e0aa"}
{"level":"info","ts":"2026-02-25T15:00:49.440214Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 switched to configuration voters=()"}
{"level":"info","ts":"2026-02-25T15:00:49.440235Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 became follower at term 0"}
{"level":"info","ts":"2026-02-25T15:00:49.440245Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b1b675f124322401 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-02-25T15:00:49.440257Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 became follower at term 1"}
{"level":"info","ts":"2026-02-25T15:00:49.440294Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 switched to configuration voters=(12805552269029417985)"}
{"level":"warn","ts":"2026-02-25T15:00:49.445043Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-02-25T15:00:49.450935Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-02-25T15:00:49.452589Z","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-02-25T15:00:49.454521Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b1b675f124322401","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-02-25T15:00:49.454689Z","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-02-25T15:00:49.454785Z","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-02-25T15:00:49.454796Z","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-02-25T15:00:49.45477Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b1b675f124322401","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-02-25T15:00:49.456192Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 switched to configuration voters=(12805552269029417985)"}
{"level":"info","ts":"2026-02-25T15:00:49.456306Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"913dfbf24a38e0aa","local-member-id":"b1b675f124322401","added-peer-id":"b1b675f124322401","added-peer-peer-urls":["https://199.204.45.149:2380"]}
{"level":"info","ts":"2026-02-25T15:00:49.461016Z","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-02-25T15:00:49.461945Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b1b675f124322401","initial-advertise-peer-urls":["https://199.204.45.149:2380"],"listen-peer-urls":["https://199.204.45.149:2380"],"advertise-client-urls":["https://199.204.45.149:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.149:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-02-25T15:00:49.461401Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.149:2380"}
{"level":"info","ts":"2026-02-25T15:00:49.462635Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.149:2380"}
{"level":"info","ts":"2026-02-25T15:00:49.461995Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-02-25T15:00:49.540864Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 is starting a new election at term 1"}
{"level":"info","ts":"2026-02-25T15:00:49.540924Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 became pre-candidate at term 1"}
{"level":"info","ts":"2026-02-25T15:00:49.540963Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 received MsgPreVoteResp from b1b675f124322401 at term 1"}
{"level":"info","ts":"2026-02-25T15:00:49.540995Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 became candidate at term 2"}
{"level":"info","ts":"2026-02-25T15:00:49.541012Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 received MsgVoteResp from b1b675f124322401 at term 2"}
{"level":"info","ts":"2026-02-25T15:00:49.541028Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b1b675f124322401 became leader at term 2"}
{"level":"info","ts":"2026-02-25T15:00:49.541046Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b1b675f124322401 elected leader b1b675f124322401 at term 2"}
{"level":"info","ts":"2026-02-25T15:00:49.542169Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b1b675f124322401","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.149:2379]}","request-path":"/0/members/b1b675f124322401/attributes","cluster-id":"913dfbf24a38e0aa","publish-timeout":"7s"}
{"level":"info","ts":"2026-02-25T15:00:49.542169Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-02-25T15:00:49.542167Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T15:00:49.542313Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-02-25T15:00:49.542538Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-02-25T15:00:49.542575Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-02-25T15:00:49.543048Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"913dfbf24a38e0aa","local-member-id":"b1b675f124322401","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T15:00:49.543194Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T15:00:49.54324Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T15:00:49.545536Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-02-25T15:00:49.548089Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.149:2379"}
{"level":"warn","ts":"2026-02-25T15:00:54.80473Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.395053ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2594527025467662924 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/services/specs/kube-system/kube-dns\" mod_revision:0 > success:<request_put:<key:\"/registry/services/specs/kube-system/kube-dns\" value_size:1143 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-02-25T15:00:54.804845Z","caller":"traceutil/trace.go:171","msg":"trace[1257798379] transaction","detail":"{read_only:false; response_revision:265; number_of_response:1; }","duration":"298.35819ms","start":"2026-02-25T15:00:54.506469Z","end":"2026-02-25T15:00:54.804827Z","steps":["trace[1257798379] 'process raft request'  (duration: 115.500014ms)","trace[1257798379] 'compare'  (duration: 182.282172ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:00:55.013335Z","caller":"traceutil/trace.go:171","msg":"trace[1754692263] transaction","detail":"{read_only:false; response_revision:266; number_of_response:1; }","duration":"426.869763ms","start":"2026-02-25T15:00:54.586398Z","end":"2026-02-25T15:00:55.013268Z","steps":["trace[1754692263] 'process raft request'  (duration: 426.455973ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:55.013532Z","caller":"traceutil/trace.go:171","msg":"trace[1713260512] transaction","detail":"{read_only:false; response_revision:268; number_of_response:1; }","duration":"407.918128ms","start":"2026-02-25T15:00:54.60557Z","end":"2026-02-25T15:00:55.013488Z","steps":["trace[1713260512] 'process raft request'  (duration: 407.811948ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:55.013635Z","caller":"traceutil/trace.go:171","msg":"trace[1606130960] transaction","detail":"{read_only:false; response_revision:269; number_of_response:1; }","duration":"407.349096ms","start":"2026-02-25T15:00:54.606219Z","end":"2026-02-25T15:00:55.013568Z","steps":["trace[1606130960] 'process raft request'  (duration: 407.190101ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:00:55.013671Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.605558Z","time spent":"408.049301ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3943,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/etcd-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/etcd-instance\" value_size:3895 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:00:55.01349Z","caller":"traceutil/trace.go:171","msg":"trace[2143802517] transaction","detail":"{read_only:false; response_revision:267; number_of_response:1; }","duration":"408.296745ms","start":"2026-02-25T15:00:54.605163Z","end":"2026-02-25T15:00:55.01346Z","steps":["trace[2143802517] 'process raft request'  (duration: 408.160092ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:00:55.013808Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.606187Z","time spent":"407.524312ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5860,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/kube-apiserver-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-apiserver-instance\" value_size:5802 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:00:55.013467Z","caller":"traceutil/trace.go:171","msg":"trace[842876283] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"425.969978ms","start":"2026-02-25T15:00:54.587441Z","end":"2026-02-25T15:00:55.013411Z","steps":["trace[842876283] 'process raft request'  (duration: 425.740287ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:00:55.013983Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.605139Z","time spent":"408.763958ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2883,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/kube-scheduler-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-scheduler-instance\" value_size:2825 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:00:55.01426Z","caller":"traceutil/trace.go:171","msg":"trace[127576214] transaction","detail":"{read_only:false; response_revision:270; number_of_response:1; }","duration":"407.029415ms","start":"2026-02-25T15:00:54.607219Z","end":"2026-02-25T15:00:55.014248Z","steps":["trace[127576214] 'process raft request'  (duration: 406.218529ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:55.014265Z","caller":"traceutil/trace.go:171","msg":"trace[1137748336] transaction","detail":"{read_only:false; response_revision:271; number_of_response:1; }","duration":"406.704774ms","start":"2026-02-25T15:00:54.607545Z","end":"2026-02-25T15:00:55.01425Z","steps":["trace[1137748336] 'process raft request'  (duration: 406.66282ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:00:55.014331Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.607533Z","time spent":"406.76799ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5476,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/kube-controller-manager-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-controller-manager-instance\" value_size:5409 >> failure:<>"}
{"level":"warn","ts":"2026-02-25T15:00:55.014369Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.607206Z","time spent":"407.0919ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3431,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/kube-vip-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-vip-instance\" value_size:3379 >> failure:<>"}
{"level":"warn","ts":"2026-02-25T15:00:55.014137Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.586379Z","time spent":"427.181912ms","remote":"127.0.0.1:39444","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":642,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/events/default/instance.18978566b63d22dd\" mod_revision:0 > success:<request_put:<key:\"/registry/events/default/instance.18978566b63d22dd\" value_size:574 lease:2594527025467662705 >> failure:<>"}
{"level":"warn","ts":"2026-02-25T15:00:55.014513Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:00:54.587419Z","time spent":"426.597757ms","remote":"127.0.0.1:39528","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":29,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:0 > success:<request_put:<key:\"/registry/minions/instance\" value_size:2781 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:00:55.020645Z","caller":"traceutil/trace.go:171","msg":"trace[2089256274] transaction","detail":"{read_only:false; response_revision:272; number_of_response:1; }","duration":"209.978894ms","start":"2026-02-25T15:00:54.810648Z","end":"2026-02-25T15:00:55.020627Z","steps":["trace[2089256274] 'process raft request'  (duration: 209.645713ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:00:57.347941Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.566511ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"}
{"level":"info","ts":"2026-02-25T15:00:57.348037Z","caller":"traceutil/trace.go:171","msg":"trace[61894208] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:312; }","duration":"202.711595ms","start":"2026-02-25T15:00:57.145304Z","end":"2026-02-25T15:00:57.348015Z","steps":["trace[61894208] 'range keys from in-memory index tree'  (duration: 202.481754ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:57.703671Z","caller":"traceutil/trace.go:171","msg":"trace[1406119989] transaction","detail":"{read_only:false; response_revision:316; number_of_response:1; }","duration":"157.635389ms","start":"2026-02-25T15:00:57.546004Z","end":"2026-02-25T15:00:57.703639Z","steps":["trace[1406119989] 'process raft request'  (duration: 133.459091ms)","trace[1406119989] 'compare'  (duration: 24.028204ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:00:58.217732Z","caller":"traceutil/trace.go:171","msg":"trace[805767928] transaction","detail":"{read_only:false; response_revision:318; number_of_response:1; }","duration":"121.017442ms","start":"2026-02-25T15:00:58.096692Z","end":"2026-02-25T15:00:58.21771Z","steps":["trace[805767928] 'process raft request'  (duration: 120.899181ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:58.431281Z","caller":"traceutil/trace.go:171","msg":"trace[1799779629] transaction","detail":"{read_only:false; response_revision:319; number_of_response:1; }","duration":"186.637893ms","start":"2026-02-25T15:00:58.244623Z","end":"2026-02-25T15:00:58.431261Z","steps":["trace[1799779629] 'process raft request'  (duration: 186.529112ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:00:58.659973Z","caller":"traceutil/trace.go:171","msg":"trace[1341647291] transaction","detail":"{read_only:false; response_revision:321; number_of_response:1; }","duration":"113.918499ms","start":"2026-02-25T15:00:58.546007Z","end":"2026-02-25T15:00:58.659925Z","steps":["trace[1341647291] 'process raft request'  (duration: 68.539967ms)","trace[1341647291] 'compare'  (duration: 45.174512ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:00:58.853746Z","caller":"traceutil/trace.go:171","msg":"trace[1098375219] transaction","detail":"{read_only:false; response_revision:322; number_of_response:1; }","duration":"157.263098ms","start":"2026-02-25T15:00:58.69645Z","end":"2026-02-25T15:00:58.853714Z","steps":["trace[1098375219] 'process raft request'  (duration: 138.684477ms)","trace[1098375219] 'compare'  (duration: 18.450979ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:00:59.088209Z","caller":"traceutil/trace.go:171","msg":"trace[1018967862] transaction","detail":"{read_only:false; response_revision:323; number_of_response:1; }","duration":"225.300039ms","start":"2026-02-25T15:00:58.862881Z","end":"2026-02-25T15:00:59.088181Z","steps":["trace[1018967862] 'process raft request'  (duration: 157.308883ms)","trace[1018967862] 'compare'  (duration: 67.804308ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:21.058434Z","caller":"traceutil/trace.go:171","msg":"trace[1458572152] linearizableReadLoop","detail":"{readStateIndex:493; appliedIndex:492; }","duration":"100.229406ms","start":"2026-02-25T15:01:20.958184Z","end":"2026-02-25T15:01:21.058413Z","steps":["trace[1458572152] 'read index received'  (duration: 100.039272ms)","trace[1458572152] 'applied index is now lower than readState.Index'  (duration: 189.304µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:21.058488Z","caller":"traceutil/trace.go:171","msg":"trace[1585971778] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"111.793765ms","start":"2026-02-25T15:01:20.946672Z","end":"2026-02-25T15:01:21.058466Z","steps":["trace[1585971778] 'process raft request'  (duration: 111.547293ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:21.05854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.344431ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:21.058579Z","caller":"traceutil/trace.go:171","msg":"trace[522816289] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:476; }","duration":"100.428088ms","start":"2026-02-25T15:01:20.958143Z","end":"2026-02-25T15:01:21.058571Z","steps":["trace[522816289] 'agreement among raft nodes before linearized reading'  (duration: 100.358381ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:21.863893Z","caller":"traceutil/trace.go:171","msg":"trace[832236671] linearizableReadLoop","detail":"{readStateIndex:494; appliedIndex:493; }","duration":"168.978025ms","start":"2026-02-25T15:01:21.694867Z","end":"2026-02-25T15:01:21.863845Z","steps":["trace[832236671] 'read index received'  (duration: 168.785932ms)","trace[832236671] 'applied index is now lower than readState.Index'  (duration: 191.273µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:21.863935Z","caller":"traceutil/trace.go:171","msg":"trace[205432074] transaction","detail":"{read_only:false; response_revision:477; number_of_response:1; }","duration":"214.693554ms","start":"2026-02-25T15:01:21.649208Z","end":"2026-02-25T15:01:21.863901Z","steps":["trace[205432074] 'process raft request'  (duration: 214.51915ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:21.864063Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.866782ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"warn","ts":"2026-02-25T15:01:21.864066Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.172879ms","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-02-25T15:01:21.864094Z","caller":"traceutil/trace.go:171","msg":"trace[1412915221] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:477; }","duration":"167.954349ms","start":"2026-02-25T15:01:21.696133Z","end":"2026-02-25T15:01:21.864087Z","steps":["trace[1412915221] 'agreement among raft nodes before linearized reading'  (duration: 167.870532ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:21.864129Z","caller":"traceutil/trace.go:171","msg":"trace[412699171] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:477; }","duration":"169.290834ms","start":"2026-02-25T15:01:21.694822Z","end":"2026-02-25T15:01:21.864113Z","steps":["trace[412699171] 'agreement among raft nodes before linearized reading'  (duration: 169.147999ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:22.068466Z","caller":"traceutil/trace.go:171","msg":"trace[40707467] linearizableReadLoop","detail":"{readStateIndex:496; appliedIndex:495; }","duration":"108.115338ms","start":"2026-02-25T15:01:21.960334Z","end":"2026-02-25T15:01:22.068449Z","steps":["trace[40707467] 'read index received'  (duration: 44.785091ms)","trace[40707467] 'applied index is now lower than readState.Index'  (duration: 63.329688ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:22.06854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.195766ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:22.068557Z","caller":"traceutil/trace.go:171","msg":"trace[1332511733] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:479; }","duration":"108.261354ms","start":"2026-02-25T15:01:21.96029Z","end":"2026-02-25T15:01:22.068552Z","steps":["trace[1332511733] 'agreement among raft nodes before linearized reading'  (duration: 108.219226ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:22.068621Z","caller":"traceutil/trace.go:171","msg":"trace[1507954955] transaction","detail":"{read_only:false; response_revision:479; number_of_response:1; }","duration":"199.735851ms","start":"2026-02-25T15:01:21.86886Z","end":"2026-02-25T15:01:22.068596Z","steps":["trace[1507954955] 'process raft request'  (duration: 136.381263ms)","trace[1507954955] 'compare'  (duration: 63.147704ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:30.253875Z","caller":"traceutil/trace.go:171","msg":"trace[1553823934] transaction","detail":"{read_only:false; response_revision:510; number_of_response:1; }","duration":"165.985704ms","start":"2026-02-25T15:01:30.087877Z","end":"2026-02-25T15:01:30.253863Z","steps":["trace[1553823934] 'process raft request'  (duration: 165.838207ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:30.253963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.649142ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-02-25T15:01:30.25399Z","caller":"traceutil/trace.go:171","msg":"trace[1327548799] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:510; }","duration":"139.71972ms","start":"2026-02-25T15:01:30.114263Z","end":"2026-02-25T15:01:30.253983Z","steps":["trace[1327548799] 'agreement among raft nodes before linearized reading'  (duration: 139.655161ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:30.25386Z","caller":"traceutil/trace.go:171","msg":"trace[942897464] linearizableReadLoop","detail":"{readStateIndex:529; appliedIndex:528; }","duration":"139.535594ms","start":"2026-02-25T15:01:30.114305Z","end":"2026-02-25T15:01:30.25384Z","steps":["trace[942897464] 'read index received'  (duration: 139.415036ms)","trace[942897464] 'applied index is now lower than readState.Index'  (duration: 119.678µs)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:43.398736Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"438.967143ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:43.398835Z","caller":"traceutil/trace.go:171","msg":"trace[181566596] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:528; }","duration":"439.087043ms","start":"2026-02-25T15:01:42.959709Z","end":"2026-02-25T15:01:43.398796Z","steps":["trace[181566596] 'range keys from in-memory index tree'  (duration: 438.905133ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:43.398868Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:42.959692Z","time spent":"439.168932ms","remote":"127.0.0.1:53268","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-02-25T15:01:46.903545Z","caller":"traceutil/trace.go:171","msg":"trace[233117084] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"210.013028ms","start":"2026-02-25T15:01:46.693479Z","end":"2026-02-25T15:01:46.903492Z","steps":["trace[233117084] 'process raft request'  (duration: 191.1137ms)","trace[233117084] 'compare'  (duration: 18.686897ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:46.903554Z","caller":"traceutil/trace.go:171","msg":"trace[1358449853] transaction","detail":"{read_only:false; response_revision:557; number_of_response:1; }","duration":"207.382449ms","start":"2026-02-25T15:01:46.696122Z","end":"2026-02-25T15:01:46.903504Z","steps":["trace[1358449853] 'process raft request'  (duration: 207.291109ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.058688Z","caller":"traceutil/trace.go:171","msg":"trace[1241389031] transaction","detail":"{read_only:false; response_revision:558; number_of_response:1; }","duration":"238.081285ms","start":"2026-02-25T15:01:46.820581Z","end":"2026-02-25T15:01:47.058662Z","steps":["trace[1241389031] 'process raft request'  (duration: 237.954315ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.112649Z","caller":"traceutil/trace.go:171","msg":"trace[864657663] transaction","detail":"{read_only:false; response_revision:559; number_of_response:1; }","duration":"202.28584ms","start":"2026-02-25T15:01:46.910335Z","end":"2026-02-25T15:01:47.11262Z","steps":["trace[864657663] 'process raft request'  (duration: 202.067359ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.112722Z","caller":"traceutil/trace.go:171","msg":"trace[74083480] linearizableReadLoop","detail":"{readStateIndex:582; appliedIndex:579; }","duration":"153.600631ms","start":"2026-02-25T15:01:46.959091Z","end":"2026-02-25T15:01:47.112691Z","steps":["trace[74083480] 'read index received'  (duration: 99.498418ms)","trace[74083480] 'applied index is now lower than readState.Index'  (duration: 54.100763ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:47.112885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.770032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:47.112882Z","caller":"traceutil/trace.go:171","msg":"trace[2070991033] transaction","detail":"{read_only:false; response_revision:560; number_of_response:1; }","duration":"202.31336ms","start":"2026-02-25T15:01:46.910541Z","end":"2026-02-25T15:01:47.112854Z","steps":["trace[2070991033] 'process raft request'  (duration: 202.020038ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.112986Z","caller":"traceutil/trace.go:171","msg":"trace[1548941435] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:561; }","duration":"153.910402ms","start":"2026-02-25T15:01:46.959058Z","end":"2026-02-25T15:01:47.112969Z","steps":["trace[1548941435] 'agreement among raft nodes before linearized reading'  (duration: 153.750411ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.40492Z","caller":"traceutil/trace.go:171","msg":"trace[1419566587] transaction","detail":"{read_only:false; response_revision:562; number_of_response:1; }","duration":"342.124915ms","start":"2026-02-25T15:01:47.062769Z","end":"2026-02-25T15:01:47.404894Z","steps":["trace[1419566587] 'process raft request'  (duration: 312.19164ms)","trace[1419566587] 'compare'  (duration: 29.799855ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:47.405386Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.062753Z","time spent":"342.338586ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4309,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" mod_revision:558 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" value_size:4218 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" > >"}
{"level":"info","ts":"2026-02-25T15:01:47.564049Z","caller":"traceutil/trace.go:171","msg":"trace[320716332] transaction","detail":"{read_only:false; response_revision:563; number_of_response:1; }","duration":"442.089972ms","start":"2026-02-25T15:01:47.121936Z","end":"2026-02-25T15:01:47.564026Z","steps":["trace[320716332] 'process raft request'  (duration: 440.159223ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.564049Z","caller":"traceutil/trace.go:171","msg":"trace[37659994] transaction","detail":"{read_only:false; response_revision:564; number_of_response:1; }","duration":"343.21612ms","start":"2026-02-25T15:01:47.22082Z","end":"2026-02-25T15:01:47.564037Z","steps":["trace[37659994] 'process raft request'  (duration: 343.16161ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:47.564219Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.121916Z","time spent":"442.232893ms","remote":"127.0.0.1:39792","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4672,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/deployments/kube-system/cilium-operator\" mod_revision:468 > success:<request_put:<key:\"/registry/deployments/kube-system/cilium-operator\" value_size:4615 >> failure:<request_range:<key:\"/registry/deployments/kube-system/cilium-operator\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:47.564323Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.220791Z","time spent":"343.357181ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4234,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodeconfigs.cilium.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodeconfigs.cilium.io\" value_size:4142 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:01:47.751104Z","caller":"traceutil/trace.go:171","msg":"trace[773970349] transaction","detail":"{read_only:false; response_revision:566; number_of_response:1; }","duration":"340.137516ms","start":"2026-02-25T15:01:47.410954Z","end":"2026-02-25T15:01:47.751091Z","steps":["trace[773970349] 'process raft request'  (duration: 340.055396ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.751098Z","caller":"traceutil/trace.go:171","msg":"trace[2062699374] transaction","detail":"{read_only:false; response_revision:565; number_of_response:1; }","duration":"340.700639ms","start":"2026-02-25T15:01:47.410376Z","end":"2026-02-25T15:01:47.751076Z","steps":["trace[2062699374] 'process raft request'  (duration: 339.938566ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.751174Z","caller":"traceutil/trace.go:171","msg":"trace[1354407080] linearizableReadLoop","detail":"{readStateIndex:589; appliedIndex:586; }","duration":"132.356544ms","start":"2026-02-25T15:01:47.618806Z","end":"2026-02-25T15:01:47.751163Z","steps":["trace[1354407080] 'read index received'  (duration: 131.425639ms)","trace[1354407080] 'applied index is now lower than readState.Index'  (duration: 929.955µs)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:47.751203Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.410943Z","time spent":"340.205727ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4318,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" mod_revision:562 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" value_size:4227 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:47.751201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.410355Z","time spent":"340.79727ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4059,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" mod_revision:561 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" value_size:3968 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:47.751236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.426104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:47.751261Z","caller":"traceutil/trace.go:171","msg":"trace[1956349648] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io; range_end:; response_count:0; response_revision:567; }","duration":"132.478835ms","start":"2026-02-25T15:01:47.618775Z","end":"2026-02-25T15:01:47.751253Z","steps":["trace[1956349648] 'agreement among raft nodes before linearized reading'  (duration: 132.421155ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:47.751313Z","caller":"traceutil/trace.go:171","msg":"trace[3999739] transaction","detail":"{read_only:false; response_revision:567; number_of_response:1; }","duration":"331.117182ms","start":"2026-02-25T15:01:47.420176Z","end":"2026-02-25T15:01:47.751293Z","steps":["trace[3999739] 'process raft request'  (duration: 330.894841ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:47.751421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.420136Z","time spent":"331.238433ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8270,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" value_size:8170 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:01:47.940651Z","caller":"traceutil/trace.go:171","msg":"trace[1505799063] transaction","detail":"{read_only:false; response_revision:568; number_of_response:1; }","duration":"183.321972ms","start":"2026-02-25T15:01:47.757303Z","end":"2026-02-25T15:01:47.940625Z","steps":["trace[1505799063] 'process raft request'  (duration: 183.169401ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:48.198814Z","caller":"traceutil/trace.go:171","msg":"trace[1331587856] transaction","detail":"{read_only:false; response_revision:570; number_of_response:1; }","duration":"376.059492ms","start":"2026-02-25T15:01:47.822732Z","end":"2026-02-25T15:01:48.198791Z","steps":["trace[1331587856] 'process raft request'  (duration: 376.013692ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:48.198907Z","caller":"traceutil/trace.go:171","msg":"trace[1088662894] transaction","detail":"{read_only:false; response_revision:569; number_of_response:1; }","duration":"441.113638ms","start":"2026-02-25T15:01:47.757758Z","end":"2026-02-25T15:01:48.198872Z","steps":["trace[1088662894] 'process raft request'  (duration: 396.92412ms)","trace[1088662894] 'compare'  (duration: 43.942866ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:48.199086Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.757735Z","time spent":"441.253959ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4068,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" mod_revision:565 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" value_size:3977 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:48.199195Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.822706Z","time spent":"376.249513ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":12244,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" value_size:12154 >> failure:<>"}
{"level":"info","ts":"2026-02-25T15:01:48.247869Z","caller":"traceutil/trace.go:171","msg":"trace[306329463] transaction","detail":"{read_only:false; response_revision:571; number_of_response:1; }","duration":"300.173719ms","start":"2026-02-25T15:01:47.947662Z","end":"2026-02-25T15:01:48.247835Z","steps":["trace[306329463] 'process raft request'  (duration: 299.904067ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:48.248041Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:47.947643Z","time spent":"300.307981ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9296,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" mod_revision:567 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" value_size:9196 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" > >"}
{"level":"info","ts":"2026-02-25T15:01:48.254205Z","caller":"traceutil/trace.go:171","msg":"trace[1542783774] linearizableReadLoop","detail":"{readStateIndex:593; appliedIndex:590; }","duration":"293.923867ms","start":"2026-02-25T15:01:47.960265Z","end":"2026-02-25T15:01:48.254189Z","steps":["trace[1542783774] 'read index received'  (duration: 194.433555ms)","trace[1542783774] 'applied index is now lower than readState.Index'  (duration: 99.489542ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:48.254302Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.032538ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:48.254318Z","caller":"traceutil/trace.go:171","msg":"trace[1356902490] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:572; }","duration":"294.096298ms","start":"2026-02-25T15:01:47.960216Z","end":"2026-02-25T15:01:48.254313Z","steps":["trace[1356902490] 'agreement among raft nodes before linearized reading'  (duration: 294.054368ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:48.254454Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.351701ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:48.25447Z","caller":"traceutil/trace.go:171","msg":"trace[1979292983] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io; range_end:; response_count:0; response_revision:572; }","duration":"234.399271ms","start":"2026-02-25T15:01:48.020064Z","end":"2026-02-25T15:01:48.254463Z","steps":["trace[1979292983] 'agreement among raft nodes before linearized reading'  (duration: 234.375901ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:48.604159Z","caller":"traceutil/trace.go:171","msg":"trace[1241391100] transaction","detail":"{read_only:false; response_revision:574; number_of_response:1; }","duration":"341.278668ms","start":"2026-02-25T15:01:48.262839Z","end":"2026-02-25T15:01:48.604118Z","steps":["trace[1241391100] 'process raft request'  (duration: 340.963856ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:48.604327Z","caller":"traceutil/trace.go:171","msg":"trace[1439915308] transaction","detail":"{read_only:false; response_revision:575; number_of_response:1; }","duration":"341.400448ms","start":"2026-02-25T15:01:48.262886Z","end":"2026-02-25T15:01:48.604286Z","steps":["trace[1439915308] 'process raft request'  (duration: 341.124466ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:48.604399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.56611ms","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-02-25T15:01:48.604442Z","caller":"traceutil/trace.go:171","msg":"trace[44196268] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:576; }","duration":"252.673161ms","start":"2026-02-25T15:01:48.351758Z","end":"2026-02-25T15:01:48.604431Z","steps":["trace[44196268] 'agreement among raft nodes before linearized reading'  (duration: 252.47319ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:48.604347Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.262824Z","time spent":"341.42731ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:541 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-02-25T15:01:48.604457Z","caller":"traceutil/trace.go:171","msg":"trace[471762977] transaction","detail":"{read_only:false; response_revision:576; number_of_response:1; }","duration":"341.524009ms","start":"2026-02-25T15:01:48.262909Z","end":"2026-02-25T15:01:48.604433Z","steps":["trace[471762977] 'process raft request'  (duration: 341.162457ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:48.604527Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.262866Z","time spent":"341.5548ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9305,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" mod_revision:571 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" value_size:9205 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:48.604592Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.262902Z","time spent":"341.625819ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":417,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:540 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:367 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-02-25T15:01:48.604157Z","caller":"traceutil/trace.go:171","msg":"trace[1096563378] linearizableReadLoop","detail":"{readStateIndex:599; appliedIndex:596; }","duration":"252.314319ms","start":"2026-02-25T15:01:48.351803Z","end":"2026-02-25T15:01:48.604118Z","steps":["trace[1096563378] 'read index received'  (duration: 251.996947ms)","trace[1096563378] 'applied index is now lower than readState.Index'  (duration: 315.832µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:49.047492Z","caller":"traceutil/trace.go:171","msg":"trace[1243233823] linearizableReadLoop","detail":"{readStateIndex:600; appliedIndex:599; }","duration":"442.815892ms","start":"2026-02-25T15:01:48.60464Z","end":"2026-02-25T15:01:49.047456Z","steps":["trace[1243233823] 'read index received'  (duration: 442.598221ms)","trace[1243233823] 'applied index is now lower than readState.Index'  (duration: 216.901µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:49.047499Z","caller":"traceutil/trace.go:171","msg":"trace[79931350] transaction","detail":"{read_only:false; response_revision:577; number_of_response:1; }","duration":"622.559632ms","start":"2026-02-25T15:01:48.424921Z","end":"2026-02-25T15:01:49.04748Z","steps":["trace[79931350] 'process raft request'  (duration: 622.206369ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.047659Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.4249Z","time spent":"622.693163ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":23277,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" value_size:23189 >> failure:<>"}
{"level":"warn","ts":"2026-02-25T15:01:49.047751Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"694.605468ms","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-02-25T15:01:49.047812Z","caller":"traceutil/trace.go:171","msg":"trace[1256859626] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:577; }","duration":"694.699569ms","start":"2026-02-25T15:01:48.353101Z","end":"2026-02-25T15:01:49.0478Z","steps":["trace[1256859626] 'agreement among raft nodes before linearized reading'  (duration: 694.444308ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.047853Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.353084Z","time spent":"694.76155ms","remote":"127.0.0.1:39602","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-02-25T15:01:49.090722Z","caller":"traceutil/trace.go:171","msg":"trace[864772084] transaction","detail":"{read_only:false; response_revision:578; number_of_response:1; }","duration":"482.211281ms","start":"2026-02-25T15:01:48.60849Z","end":"2026-02-25T15:01:49.090702Z","steps":["trace[864772084] 'process raft request'  (duration: 482.0429ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.090926Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.608465Z","time spent":"482.386623ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:542 > 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-02-25T15:01:49.091136Z","caller":"traceutil/trace.go:171","msg":"trace[1355405144] transaction","detail":"{read_only:false; response_revision:579; number_of_response:1; }","duration":"473.435969ms","start":"2026-02-25T15:01:48.617689Z","end":"2026-02-25T15:01:49.091126Z","steps":["trace[1355405144] 'process raft request'  (duration: 472.956356ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.091144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"473.246698ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io\" ","response":"range_response_count:1 size:4180"}
{"level":"warn","ts":"2026-02-25T15:01:49.09119Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.617654Z","time spent":"473.510249ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":13214,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" mod_revision:573 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" value_size:13124 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" > >"}
{"level":"info","ts":"2026-02-25T15:01:49.091222Z","caller":"traceutil/trace.go:171","msg":"trace[1398051882] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io; range_end:; response_count:1; response_revision:579; }","duration":"473.376389ms","start":"2026-02-25T15:01:48.617823Z","end":"2026-02-25T15:01:49.0912Z","steps":["trace[1398051882] 'agreement among raft nodes before linearized reading'  (duration: 473.088087ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.091285Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.617799Z","time spent":"473.474249ms","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":85,"response count":1,"response size":4204,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io\" "}
{"level":"warn","ts":"2026-02-25T15:01:49.091582Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"273.064565ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumexternalworkloads.cilium.io\" ","response":"range_response_count:1 size:5586"}
{"level":"info","ts":"2026-02-25T15:01:49.091717Z","caller":"traceutil/trace.go:171","msg":"trace[1391209344] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumexternalworkloads.cilium.io; range_end:; response_count:1; response_revision:579; }","duration":"273.303156ms","start":"2026-02-25T15:01:48.818383Z","end":"2026-02-25T15:01:49.091686Z","steps":["trace[1391209344] 'agreement among raft nodes before linearized reading'  (duration: 272.743132ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.091954Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"442.993355ms","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-02-25T15:01:49.09207Z","caller":"traceutil/trace.go:171","msg":"trace[15648177] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:579; }","duration":"443.169776ms","start":"2026-02-25T15:01:48.648848Z","end":"2026-02-25T15:01:49.092018Z","steps":["trace[15648177] 'agreement among raft nodes before linearized reading'  (duration: 442.332201ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:49.092175Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:48.648827Z","time spent":"443.330988ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"info","ts":"2026-02-25T15:01:49.23214Z","caller":"traceutil/trace.go:171","msg":"trace[722904719] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"172.93694ms","start":"2026-02-25T15:01:49.059181Z","end":"2026-02-25T15:01:49.232118Z","steps":["trace[722904719] 'process raft request'  (duration: 172.872529ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:49.232152Z","caller":"traceutil/trace.go:171","msg":"trace[1803910346] transaction","detail":"{read_only:false; response_revision:580; number_of_response:1; }","duration":"180.972019ms","start":"2026-02-25T15:01:49.051147Z","end":"2026-02-25T15:01:49.232119Z","steps":["trace[1803910346] 'process raft request'  (duration: 180.752317ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:49.238667Z","caller":"traceutil/trace.go:171","msg":"trace[1982588006] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"138.856194ms","start":"2026-02-25T15:01:49.099792Z","end":"2026-02-25T15:01:49.238648Z","steps":["trace[1982588006] 'process raft request'  (duration: 138.624203ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:50.918604Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2594527025467663623,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-02-25T15:01:51.419786Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2594527025467663623,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-02-25T15:01:51.92067Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2594527025467663623,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-02-25T15:01:52.136391Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.979575716s","expected-duration":"1s"}
{"level":"info","ts":"2026-02-25T15:01:52.137292Z","caller":"traceutil/trace.go:171","msg":"trace[665700925] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"1.98076679s","start":"2026-02-25T15:01:50.15649Z","end":"2026-02-25T15:01:52.137256Z","steps":["trace[665700925] 'process raft request'  (duration: 1.980333515s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.137501Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.156467Z","time spent":"1.980915881s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":188228,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" mod_revision:587 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" value_size:188130 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" > >"}
{"level":"info","ts":"2026-02-25T15:01:52.15706Z","caller":"traceutil/trace.go:171","msg":"trace[1763815847] linearizableReadLoop","detail":"{readStateIndex:612; appliedIndex:610; }","duration":"1.738851296s","start":"2026-02-25T15:01:50.418185Z","end":"2026-02-25T15:01:52.157037Z","steps":["trace[1763815847] 'read index received'  (duration: 1.718580609s)","trace[1763815847] 'applied index is now lower than readState.Index'  (duration: 20.269797ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:52.157485Z","caller":"traceutil/trace.go:171","msg":"trace[1837246650] transaction","detail":"{read_only:false; response_revision:589; number_of_response:1; }","duration":"1.880910328s","start":"2026-02-25T15:01:50.276567Z","end":"2026-02-25T15:01:52.157478Z","steps":["trace[1837246650] 'process raft request'  (duration: 1.880313502s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.157571Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.276543Z","time spent":"1.880968839s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":187455,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io\" value_size:187346 >> failure:<>"}
{"level":"warn","ts":"2026-02-25T15:01:52.157801Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.739616234s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" ","response":"range_response_count:1 size:13229"}
{"level":"info","ts":"2026-02-25T15:01:52.157923Z","caller":"traceutil/trace.go:171","msg":"trace[91159637] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io; range_end:; response_count:1; response_revision:589; }","duration":"1.739774045s","start":"2026-02-25T15:01:50.418139Z","end":"2026-02-25T15:01:52.157913Z","steps":["trace[91159637] 'agreement among raft nodes before linearized reading'  (duration: 1.739563033s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.157944Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.418124Z","time spent":"1.739813415s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":84,"response count":1,"response size":13253,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.158069Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.549232827s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"}
{"level":"info","ts":"2026-02-25T15:01:52.1581Z","caller":"traceutil/trace.go:171","msg":"trace[587662900] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:589; }","duration":"1.549301468s","start":"2026-02-25T15:01:50.608792Z","end":"2026-02-25T15:01:52.158094Z","steps":["trace[587662900] 'agreement among raft nodes before linearized reading'  (duration: 1.549232267s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.158119Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.608772Z","time spent":"1.549343078s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.158588Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.317429ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:52.158616Z","caller":"traceutil/trace.go:171","msg":"trace[2078161265] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:589; }","duration":"199.36926ms","start":"2026-02-25T15:01:51.95924Z","end":"2026-02-25T15:01:52.15861Z","steps":["trace[2078161265] 'agreement among raft nodes before linearized reading'  (duration: 199.32715ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.158742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"905.552924ms","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-02-25T15:01:52.158766Z","caller":"traceutil/trace.go:171","msg":"trace[1923923811] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:589; }","duration":"905.609496ms","start":"2026-02-25T15:01:51.253151Z","end":"2026-02-25T15:01:52.158761Z","steps":["trace[1923923811] 'agreement among raft nodes before linearized reading'  (duration: 905.545965ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.158784Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:51.253131Z","time spent":"905.649346ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.158894Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"922.581937ms","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-02-25T15:01:52.158919Z","caller":"traceutil/trace.go:171","msg":"trace[96915367] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:589; }","duration":"922.634457ms","start":"2026-02-25T15:01:51.236279Z","end":"2026-02-25T15:01:52.158914Z","steps":["trace[96915367] 'agreement among raft nodes before linearized reading'  (duration: 922.578307ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.158936Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:51.23626Z","time spent":"922.671988ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.159021Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.061779073s","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-02-25T15:01:52.159046Z","caller":"traceutil/trace.go:171","msg":"trace[1600606044] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:589; }","duration":"1.061838064s","start":"2026-02-25T15:01:51.097202Z","end":"2026-02-25T15:01:52.15904Z","steps":["trace[1600606044] 'agreement among raft nodes before linearized reading'  (duration: 1.061800864s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.159068Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:51.097182Z","time spent":"1.061879425s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.159275Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.140122351s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" ","response":"range_response_count:1 size:188243"}
{"level":"info","ts":"2026-02-25T15:01:52.159301Z","caller":"traceutil/trace.go:171","msg":"trace[1828229429] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io; range_end:; response_count:1; response_revision:589; }","duration":"1.140184621s","start":"2026-02-25T15:01:51.019111Z","end":"2026-02-25T15:01:52.159296Z","steps":["trace[1828229429] 'agreement among raft nodes before linearized reading'  (duration: 1.140028609s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.159319Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:51.019093Z","time spent":"1.140222271s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":90,"response count":1,"response size":188267,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.159509Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.340718591s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io\" ","response":"range_response_count:1 size:10377"}
{"level":"info","ts":"2026-02-25T15:01:52.159536Z","caller":"traceutil/trace.go:171","msg":"trace[2126909674] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io; range_end:; response_count:1; response_revision:589; }","duration":"1.340771441s","start":"2026-02-25T15:01:50.818758Z","end":"2026-02-25T15:01:52.159529Z","steps":["trace[2126909674] 'agreement among raft nodes before linearized reading'  (duration: 1.34070979s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.159554Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.818742Z","time spent":"1.340807513s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":1,"response size":10401,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.159633Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.404775629s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllers/\" range_end:\"/registry/controllers0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:52.159659Z","caller":"traceutil/trace.go:171","msg":"trace[689805885] range","detail":"{range_begin:/registry/controllers/; range_end:/registry/controllers0; response_count:0; response_revision:589; }","duration":"1.404866721s","start":"2026-02-25T15:01:50.754786Z","end":"2026-02-25T15:01:52.159653Z","steps":["trace[689805885] 'agreement among raft nodes before linearized reading'  (duration: 1.4048297s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.159677Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.754758Z","time spent":"1.404913551s","remote":"127.0.0.1:39564","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":29,"request content":"key:\"/registry/controllers/\" range_end:\"/registry/controllers0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:01:52.159809Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.541451996s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" ","response":"range_response_count:1 size:24244"}
{"level":"info","ts":"2026-02-25T15:01:52.159833Z","caller":"traceutil/trace.go:171","msg":"trace[511583459] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io; range_end:; response_count:1; response_revision:589; }","duration":"1.541499537s","start":"2026-02-25T15:01:50.618328Z","end":"2026-02-25T15:01:52.159828Z","steps":["trace[511583459] 'agreement among raft nodes before linearized reading'  (duration: 1.541433106s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.159852Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.618318Z","time spent":"1.541530207s","remote":"127.0.0.1:39410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":1,"response size":24268,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" "}
{"level":"warn","ts":"2026-02-25T15:01:52.161058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.552185748s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-02-25T15:01:52.161092Z","caller":"traceutil/trace.go:171","msg":"trace[887924791] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:589; }","duration":"1.552262399s","start":"2026-02-25T15:01:50.608822Z","end":"2026-02-25T15:01:52.161084Z","steps":["trace[887924791] 'agreement among raft nodes before linearized reading'  (duration: 1.551097047s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:52.161111Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:50.608801Z","time spent":"1.55230601s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-02-25T15:01:53.420112Z","caller":"traceutil/trace.go:171","msg":"trace[1772124455] linearizableReadLoop","detail":"{readStateIndex:624; appliedIndex:623; }","duration":"113.283471ms","start":"2026-02-25T15:01:53.306803Z","end":"2026-02-25T15:01:53.420087Z","steps":["trace[1772124455] 'read index received'  (duration: 113.130808ms)","trace[1772124455] 'applied index is now lower than readState.Index'  (duration: 151.863µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:53.4202Z","caller":"traceutil/trace.go:171","msg":"trace[541391360] transaction","detail":"{read_only:false; response_revision:600; number_of_response:1; }","duration":"118.960407ms","start":"2026-02-25T15:01:53.301223Z","end":"2026-02-25T15:01:53.420183Z","steps":["trace[541391360] 'process raft request'  (duration: 118.708373ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.420288Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.463163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.42033Z","caller":"traceutil/trace.go:171","msg":"trace[1415382084] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:600; }","duration":"113.543264ms","start":"2026-02-25T15:01:53.306775Z","end":"2026-02-25T15:01:53.420318Z","steps":["trace[1415382084] 'agreement among raft nodes before linearized reading'  (duration: 113.455773ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.420349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.483943ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.420428Z","caller":"traceutil/trace.go:171","msg":"trace[632551744] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:600; }","duration":"113.579824ms","start":"2026-02-25T15:01:53.306829Z","end":"2026-02-25T15:01:53.420409Z","steps":["trace[632551744] 'agreement among raft nodes before linearized reading'  (duration: 113.454422ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.42066Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.542493ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.420693Z","caller":"traceutil/trace.go:171","msg":"trace[1425961189] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:600; }","duration":"113.600434ms","start":"2026-02-25T15:01:53.307081Z","end":"2026-02-25T15:01:53.420681Z","steps":["trace[1425961189] 'agreement among raft nodes before linearized reading'  (duration: 113.550843ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.870434Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.813429ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.870507Z","caller":"traceutil/trace.go:171","msg":"trace[378531085] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:600; }","duration":"264.938951ms","start":"2026-02-25T15:01:53.605553Z","end":"2026-02-25T15:01:53.870492Z","steps":["trace[378531085] 'range keys from in-memory index tree'  (duration: 264.712798ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.870571Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.83815ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-02-25T15:01:53.870625Z","caller":"traceutil/trace.go:171","msg":"trace[456594906] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:600; }","duration":"127.937151ms","start":"2026-02-25T15:01:53.742674Z","end":"2026-02-25T15:01:53.870611Z","steps":["trace[456594906] 'count revisions from in-memory index tree'  (duration: 127.754909ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.870715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.524803ms","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-02-25T15:01:53.870766Z","caller":"traceutil/trace.go:171","msg":"trace[1753354321] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:600; }","duration":"326.576364ms","start":"2026-02-25T15:01:53.544184Z","end":"2026-02-25T15:01:53.87076Z","steps":["trace[1753354321] 'range keys from in-memory index tree'  (duration: 326.518133ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.870845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"265.75492ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.870878Z","caller":"traceutil/trace.go:171","msg":"trace[1480953225] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:600; }","duration":"265.78783ms","start":"2026-02-25T15:01:53.605083Z","end":"2026-02-25T15:01:53.870871Z","steps":["trace[1480953225] 'count revisions from in-memory index tree'  (duration: 265.688589ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:53.870883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"265.872871ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:53.870899Z","caller":"traceutil/trace.go:171","msg":"trace[1225921380] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:600; }","duration":"265.941963ms","start":"2026-02-25T15:01:53.604953Z","end":"2026-02-25T15:01:53.870895Z","steps":["trace[1225921380] 'range keys from in-memory index tree'  (duration: 265.708689ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:54.327487Z","caller":"traceutil/trace.go:171","msg":"trace[1515988419] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"146.711671ms","start":"2026-02-25T15:01:54.180749Z","end":"2026-02-25T15:01:54.327461Z","steps":["trace[1515988419] 'process raft request'  (duration: 118.857083ms)","trace[1515988419] 'compare'  (duration: 27.698696ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:54.437201Z","caller":"traceutil/trace.go:171","msg":"trace[1731392609] transaction","detail":"{read_only:false; response_revision:605; number_of_response:1; }","duration":"105.518164ms","start":"2026-02-25T15:01:54.331666Z","end":"2026-02-25T15:01:54.437184Z","steps":["trace[1731392609] 'process raft request'  (duration: 105.491183ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:54.437237Z","caller":"traceutil/trace.go:171","msg":"trace[982904801] transaction","detail":"{read_only:false; response_revision:603; number_of_response:1; }","duration":"106.130531ms","start":"2026-02-25T15:01:54.331068Z","end":"2026-02-25T15:01:54.437198Z","steps":["trace[982904801] 'process raft request'  (duration: 99.88279ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:54.437424Z","caller":"traceutil/trace.go:171","msg":"trace[2022990805] transaction","detail":"{read_only:false; response_revision:604; number_of_response:1; }","duration":"105.899309ms","start":"2026-02-25T15:01:54.331517Z","end":"2026-02-25T15:01:54.437416Z","steps":["trace[2022990805] 'process raft request'  (duration: 105.612385ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:56.387835Z","caller":"traceutil/trace.go:171","msg":"trace[749002234] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"119.653228ms","start":"2026-02-25T15:01:56.268143Z","end":"2026-02-25T15:01:56.387796Z","steps":["trace[749002234] 'process raft request'  (duration: 119.493135ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:56.461093Z","caller":"traceutil/trace.go:171","msg":"trace[1584961069] linearizableReadLoop","detail":"{readStateIndex:632; appliedIndex:631; }","duration":"129.643537ms","start":"2026-02-25T15:01:56.331426Z","end":"2026-02-25T15:01:56.46107Z","steps":["trace[1584961069] 'read index received'  (duration: 56.646226ms)","trace[1584961069] 'applied index is now lower than readState.Index'  (duration: 72.996551ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:01:56.461107Z","caller":"traceutil/trace.go:171","msg":"trace[665016813] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"192.071191ms","start":"2026-02-25T15:01:56.269015Z","end":"2026-02-25T15:01:56.461086Z","steps":["trace[665016813] 'process raft request'  (duration: 147.86573ms)","trace[665016813] 'compare'  (duration: 44.095139ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:56.461213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.785639ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-02-25T15:01:56.461238Z","caller":"traceutil/trace.go:171","msg":"trace[1746766672] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:608; }","duration":"129.86305ms","start":"2026-02-25T15:01:56.331368Z","end":"2026-02-25T15:01:56.461232Z","steps":["trace[1746766672] 'agreement among raft nodes before linearized reading'  (duration: 129.775109ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:56.786056Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.976053ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2594527025467663685 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:605 > 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-02-25T15:01:56.786434Z","caller":"traceutil/trace.go:171","msg":"trace[1293318822] transaction","detail":"{read_only:false; response_revision:612; number_of_response:1; }","duration":"316.258166ms","start":"2026-02-25T15:01:56.47016Z","end":"2026-02-25T15:01:56.786418Z","steps":["trace[1293318822] 'process raft request'  (duration: 316.206555ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:56.78651Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:56.470141Z","time spent":"316.336887ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:604 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-02-25T15:01:56.786539Z","caller":"traceutil/trace.go:171","msg":"trace[1719576888] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"317.099448ms","start":"2026-02-25T15:01:56.469414Z","end":"2026-02-25T15:01:56.786513Z","steps":["trace[1719576888] 'process raft request'  (duration: 316.842095ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:56.786586Z","caller":"traceutil/trace.go:171","msg":"trace[1801198032] transaction","detail":"{read_only:false; response_revision:611; number_of_response:1; }","duration":"317.725007ms","start":"2026-02-25T15:01:56.468847Z","end":"2026-02-25T15:01:56.786572Z","steps":["trace[1801198032] 'process raft request'  (duration: 317.481034ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:01:56.786595Z","caller":"traceutil/trace.go:171","msg":"trace[1283616865] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"317.119519ms","start":"2026-02-25T15:01:56.469425Z","end":"2026-02-25T15:01:56.786544Z","steps":["trace[1283616865] 'process raft request'  (duration: 115.565127ms)","trace[1283616865] 'compare'  (duration: 200.77126ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:01:56.786683Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:56.469397Z","time spent":"317.20087ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:602 > 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-02-25T15:01:56.786693Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:56.468823Z","time spent":"317.803198ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:603 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-02-25T15:01:56.786716Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:01:56.469417Z","time spent":"317.244681ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:605 > 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-02-25T15:01:58.660247Z","caller":"traceutil/trace.go:171","msg":"trace[2085908544] transaction","detail":"{read_only:false; response_revision:613; number_of_response:1; }","duration":"189.155914ms","start":"2026-02-25T15:01:58.471071Z","end":"2026-02-25T15:01:58.660226Z","steps":["trace[2085908544] 'process raft request'  (duration: 189.017112ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:01:59.126806Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.424401ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:01:59.126894Z","caller":"traceutil/trace.go:171","msg":"trace[249986430] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:617; }","duration":"165.570434ms","start":"2026-02-25T15:01:58.961305Z","end":"2026-02-25T15:01:59.126876Z","steps":["trace[249986430] 'range keys from in-memory index tree'  (duration: 165.327399ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:01.031176Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"213.494637ms","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-02-25T15:02:01.031237Z","caller":"traceutil/trace.go:171","msg":"trace[934643214] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:618; }","duration":"213.639809ms","start":"2026-02-25T15:02:00.817584Z","end":"2026-02-25T15:02:01.031224Z","steps":["trace[934643214] 'range keys from in-memory index tree'  (duration: 213.372024ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:01.031251Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.348937ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"warn","ts":"2026-02-25T15:02:01.031324Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.391678ms","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-02-25T15:02:01.031326Z","caller":"traceutil/trace.go:171","msg":"trace[266461430] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:618; }","duration":"190.45363ms","start":"2026-02-25T15:02:00.840855Z","end":"2026-02-25T15:02:01.031308Z","steps":["trace[266461430] 'range keys from in-memory index tree'  (duration: 190.111102ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:01.031356Z","caller":"traceutil/trace.go:171","msg":"trace[638064417] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:618; }","duration":"190.471849ms","start":"2026-02-25T15:02:00.840877Z","end":"2026-02-25T15:02:01.031349Z","steps":["trace[638064417] 'range keys from in-memory index tree'  (duration: 190.216634ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:01.031519Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.102852ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-02-25T15:02:01.031549Z","caller":"traceutil/trace.go:171","msg":"trace[991575044] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:618; }","duration":"143.183773ms","start":"2026-02-25T15:02:00.888359Z","end":"2026-02-25T15:02:01.031543Z","steps":["trace[991575044] 'count revisions from in-memory index tree'  (duration: 142.981469ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:01.031625Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.787476ms","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-02-25T15:02:01.031661Z","caller":"traceutil/trace.go:171","msg":"trace[381751108] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:618; }","duration":"191.851347ms","start":"2026-02-25T15:02:00.839801Z","end":"2026-02-25T15:02:01.031652Z","steps":["trace[381751108] 'range keys from in-memory index tree'  (duration: 191.626612ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:01.232203Z","caller":"traceutil/trace.go:171","msg":"trace[1370973121] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"196.330766ms","start":"2026-02-25T15:02:01.035856Z","end":"2026-02-25T15:02:01.232187Z","steps":["trace[1370973121] 'process raft request'  (duration: 196.303526ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:01.23237Z","caller":"traceutil/trace.go:171","msg":"trace[453795624] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"196.682094ms","start":"2026-02-25T15:02:01.035681Z","end":"2026-02-25T15:02:01.232363Z","steps":["trace[453795624] 'process raft request'  (duration: 196.448299ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:01.23235Z","caller":"traceutil/trace.go:171","msg":"trace[1317207697] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"197.118702ms","start":"2026-02-25T15:02:01.035208Z","end":"2026-02-25T15:02:01.232327Z","steps":["trace[1317207697] 'process raft request'  (duration: 105.3067ms)","trace[1317207697] 'compare'  (duration: 91.494916ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:02:02.576917Z","caller":"traceutil/trace.go:171","msg":"trace[513154521] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"208.10386ms","start":"2026-02-25T15:02:02.368796Z","end":"2026-02-25T15:02:02.5769Z","steps":["trace[513154521] 'process raft request'  (duration: 207.942727ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.392333Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2594527025467663746,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-02-25T15:02:03.432928Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"748.628532ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-02-25T15:02:03.433033Z","caller":"traceutil/trace.go:171","msg":"trace[122668799] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:625; }","duration":"748.792305ms","start":"2026-02-25T15:02:02.684203Z","end":"2026-02-25T15:02:03.432996Z","steps":["trace[122668799] 'range keys from in-memory index tree'  (duration: 748.395547ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.433023Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"662.179245ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-kvhtw\" ","response":"range_response_count:1 size:16656"}
{"level":"warn","ts":"2026-02-25T15:02:03.433081Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:02.68417Z","time spent":"748.899118ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-02-25T15:02:03.433116Z","caller":"traceutil/trace.go:171","msg":"trace[245779177] range","detail":"{range_begin:/registry/pods/kube-system/cilium-kvhtw; range_end:; response_count:1; response_revision:625; }","duration":"662.310828ms","start":"2026-02-25T15:02:02.770778Z","end":"2026-02-25T15:02:03.433089Z","steps":["trace[245779177] 'range keys from in-memory index tree'  (duration: 662.060753ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.433169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:02.770753Z","time spent":"662.40096ms","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16680,"request content":"key:\"/registry/pods/kube-system/cilium-kvhtw\" "}
{"level":"info","ts":"2026-02-25T15:02:03.520508Z","caller":"traceutil/trace.go:171","msg":"trace[1510723789] linearizableReadLoop","detail":"{readStateIndex:652; appliedIndex:651; }","duration":"628.755678ms","start":"2026-02-25T15:02:02.891726Z","end":"2026-02-25T15:02:03.520482Z","steps":["trace[1510723789] 'read index received'  (duration: 628.686936ms)","trace[1510723789] 'applied index is now lower than readState.Index'  (duration: 67.802µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:02:03.52059Z","caller":"traceutil/trace.go:171","msg":"trace[1799477240] transaction","detail":"{read_only:false; response_revision:626; number_of_response:1; }","duration":"628.898661ms","start":"2026-02-25T15:02:02.891674Z","end":"2026-02-25T15:02:03.520573Z","steps":["trace[1799477240] 'process raft request'  (duration: 628.617245ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.520914Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:02.891646Z","time spent":"629.210038ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:598 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"warn","ts":"2026-02-25T15:02:03.520734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"628.981223ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.149\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-02-25T15:02:03.521119Z","caller":"traceutil/trace.go:171","msg":"trace[1249950990] range","detail":"{range_begin:/registry/masterleases/199.204.45.149; range_end:; response_count:1; response_revision:626; }","duration":"629.408992ms","start":"2026-02-25T15:02:02.891696Z","end":"2026-02-25T15:02:03.521105Z","steps":["trace[1249950990] 'agreement among raft nodes before linearized reading'  (duration: 628.884611ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.521164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:02.891682Z","time spent":"629.471083ms","remote":"127.0.0.1:39380","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":159,"request content":"key:\"/registry/masterleases/199.204.45.149\" "}
{"level":"warn","ts":"2026-02-25T15:02:03.668406Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.859146ms","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-02-25T15:02:03.668557Z","caller":"traceutil/trace.go:171","msg":"trace[648004584] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:626; }","duration":"124.0379ms","start":"2026-02-25T15:02:03.544498Z","end":"2026-02-25T15:02:03.668536Z","steps":["trace[648004584] 'range keys from in-memory index tree'  (duration: 123.801985ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:03.668815Z","caller":"traceutil/trace.go:171","msg":"trace[1659771328] linearizableReadLoop","detail":"{readStateIndex:654; appliedIndex:652; }","duration":"147.964503ms","start":"2026-02-25T15:02:03.520825Z","end":"2026-02-25T15:02:03.668789Z","steps":["trace[1659771328] 'read index received'  (duration: 127.744001ms)","trace[1659771328] 'applied index is now lower than readState.Index'  (duration: 20.218882ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:02:03.668955Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"707.73234ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:02:03.668994Z","caller":"traceutil/trace.go:171","msg":"trace[1478866860] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:628; }","duration":"707.815881ms","start":"2026-02-25T15:02:02.961169Z","end":"2026-02-25T15:02:03.668985Z","steps":["trace[1478866860] 'agreement among raft nodes before linearized reading'  (duration: 707.713339ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.669027Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:02.961155Z","time spent":"707.864732ms","remote":"127.0.0.1:53282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-02-25T15:02:03.669032Z","caller":"traceutil/trace.go:171","msg":"trace[1320970146] transaction","detail":"{read_only:false; response_revision:627; number_of_response:1; }","duration":"222.722696ms","start":"2026-02-25T15:02:03.446289Z","end":"2026-02-25T15:02:03.669011Z","steps":["trace[1320970146] 'process raft request'  (duration: 202.202668ms)","trace[1320970146] 'compare'  (duration: 19.852093ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:02:03.669063Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"433.314638ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"info","ts":"2026-02-25T15:02:03.669115Z","caller":"traceutil/trace.go:171","msg":"trace[1462373510] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:628; }","duration":"433.40774ms","start":"2026-02-25T15:02:03.235693Z","end":"2026-02-25T15:02:03.669101Z","steps":["trace[1462373510] 'agreement among raft nodes before linearized reading'  (duration: 433.185685ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:03.669107Z","caller":"traceutil/trace.go:171","msg":"trace[1010655608] transaction","detail":"{read_only:false; response_revision:628; number_of_response:1; }","duration":"220.360905ms","start":"2026-02-25T15:02:03.448721Z","end":"2026-02-25T15:02:03.669082Z","steps":["trace[1010655608] 'process raft request'  (duration: 219.946196ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.669166Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.235674Z","time spent":"433.477581ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-02-25T15:02:03.669221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"433.489891ms","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-02-25T15:02:03.669248Z","caller":"traceutil/trace.go:171","msg":"trace[45919654] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:628; }","duration":"433.535162ms","start":"2026-02-25T15:02:03.235705Z","end":"2026-02-25T15:02:03.66924Z","steps":["trace[45919654] 'agreement among raft nodes before linearized reading'  (duration: 433.43259ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.669269Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.235699Z","time spent":"433.564652ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-02-25T15:02:03.669426Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"433.769678ms","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-02-25T15:02:03.66945Z","caller":"traceutil/trace.go:171","msg":"trace[1040428617] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:628; }","duration":"433.827248ms","start":"2026-02-25T15:02:03.235617Z","end":"2026-02-25T15:02:03.669444Z","steps":["trace[1040428617] 'agreement among raft nodes before linearized reading'  (duration: 433.334498ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.669475Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.235596Z","time spent":"433.87454ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-02-25T15:02:03.670099Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"593.289381ms","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-02-25T15:02:03.670194Z","caller":"traceutil/trace.go:171","msg":"trace[363681468] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:628; }","duration":"593.425695ms","start":"2026-02-25T15:02:03.076742Z","end":"2026-02-25T15:02:03.670168Z","steps":["trace[363681468] 'agreement among raft nodes before linearized reading'  (duration: 592.247609ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:03.670241Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.076727Z","time spent":"593.503826ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-02-25T15:02:04.042474Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.071802ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2594527025467663752 username:\"kube-apiserver-etcd-client\" auth_revision:1 > lease_grant:<ttl:15-second id:24019c955126a587>","response":"size:41"}
{"level":"warn","ts":"2026-02-25T15:02:04.04258Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.522717Z","time spent":"519.857741ms","remote":"127.0.0.1:39380","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""}
{"level":"info","ts":"2026-02-25T15:02:04.055206Z","caller":"traceutil/trace.go:171","msg":"trace[381788881] transaction","detail":"{read_only:false; response_revision:629; number_of_response:1; }","duration":"382.278098ms","start":"2026-02-25T15:02:03.672903Z","end":"2026-02-25T15:02:04.055181Z","steps":["trace[381788881] 'process raft request'  (duration: 382.036553ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:04.055275Z","caller":"traceutil/trace.go:171","msg":"trace[122094053] transaction","detail":"{read_only:false; response_revision:630; number_of_response:1; }","duration":"381.104622ms","start":"2026-02-25T15:02:03.674141Z","end":"2026-02-25T15:02:04.055245Z","steps":["trace[122094053] 'process raft request'  (duration: 380.964479ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:04.05546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.67288Z","time spent":"382.461072ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:621 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-02-25T15:02:04.055516Z","caller":"traceutil/trace.go:171","msg":"trace[1612094267] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"381.284576ms","start":"2026-02-25T15:02:03.674222Z","end":"2026-02-25T15:02:04.055506Z","steps":["trace[1612094267] 'process raft request'  (duration: 380.974989ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:04.055529Z","caller":"traceutil/trace.go:171","msg":"trace[762007432] transaction","detail":"{read_only:false; response_revision:631; number_of_response:1; }","duration":"381.359228ms","start":"2026-02-25T15:02:03.674148Z","end":"2026-02-25T15:02:04.055507Z","steps":["trace[762007432] 'process raft request'  (duration: 381.01795ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:04.055574Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.674213Z","time spent":"381.335548ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:619 > 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-02-25T15:02:04.055461Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.674121Z","time spent":"381.237585ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:620 > 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-02-25T15:02:04.055674Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:03.674129Z","time spent":"381.47195ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:622 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:430 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-02-25T15:02:05.9018Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"336.5554ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:02:05.901917Z","caller":"traceutil/trace.go:171","msg":"trace[157526611] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:633; }","duration":"336.662623ms","start":"2026-02-25T15:02:05.565198Z","end":"2026-02-25T15:02:05.90186Z","steps":["trace[157526611] 'count revisions from in-memory index tree'  (duration: 336.467089ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:05.901953Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:05.56518Z","time spent":"336.764736ms","remote":"127.0.0.1:39722","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":29,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:02:05.902045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.948032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-02-25T15:02:05.902095Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.268091674s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:02:05.902147Z","caller":"traceutil/trace.go:171","msg":"trace[837598890] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:633; }","duration":"278.107586ms","start":"2026-02-25T15:02:05.624019Z","end":"2026-02-25T15:02:05.902127Z","steps":["trace[837598890] 'range keys from in-memory index tree'  (duration: 277.8392ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:05.902162Z","caller":"traceutil/trace.go:171","msg":"trace[1297015317] range","detail":"{range_begin:/registry/jobs/; range_end:/registry/jobs0; response_count:0; response_revision:633; }","duration":"1.268191416s","start":"2026-02-25T15:02:04.633949Z","end":"2026-02-25T15:02:05.902141Z","steps":["trace[1297015317] 'count revisions from in-memory index tree'  (duration: 1.267959081s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:05.90221Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:04.633933Z","time spent":"1.268261248s","remote":"127.0.0.1:39578","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:02:05.902267Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"577.081007ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-02-25T15:02:05.902306Z","caller":"traceutil/trace.go:171","msg":"trace[784393547] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:633; }","duration":"577.148869ms","start":"2026-02-25T15:02:05.325146Z","end":"2026-02-25T15:02:05.902295Z","steps":["trace[784393547] 'count revisions from in-memory index tree'  (duration: 576.979305ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:05.902329Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:05.325131Z","time spent":"577.19182ms","remote":"127.0.0.1:39464","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":5,"response size":31,"request content":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:02:05.902469Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.226045ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-02-25T15:02:05.902504Z","caller":"traceutil/trace.go:171","msg":"trace[794896922] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:633; }","duration":"228.289406ms","start":"2026-02-25T15:02:05.674202Z","end":"2026-02-25T15:02:05.902491Z","steps":["trace[794896922] 'range keys from in-memory index tree'  (duration: 228.009509ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:08.958865Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.000712673s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"","error":"context deadline exceeded"}
{"level":"info","ts":"2026-02-25T15:02:08.959182Z","caller":"traceutil/trace.go:171","msg":"trace[1705033315] range","detail":"{range_begin:/registry/health; range_end:; }","duration":"2.001086063s","start":"2026-02-25T15:02:06.958078Z","end":"2026-02-25T15:02:08.959164Z","steps":["trace[1705033315] 'agreement among raft nodes before linearized reading'  (duration: 2.000743884s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:08.959227Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.958062Z","time spent":"2.001154265s","remote":"127.0.0.1:53268","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":0,"request content":"key:\"/registry/health\" "}
2026/02/25 15:02:08 WARNING: [core] [Server #7] grpc: Server.processUnaryRPC failed to write status: connection error: desc = "transport is closing"
{"level":"warn","ts":"2026-02-25T15:02:10.095562Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"3.656208958s","expected-duration":"100ms","prefix":"","request":"header:<ID:2594527025467663771 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:606 > 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-02-25T15:02:10.096345Z","caller":"traceutil/trace.go:171","msg":"trace[810579435] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"4.112852937s","start":"2026-02-25T15:02:05.983438Z","end":"2026-02-25T15:02:10.096291Z","steps":["trace[810579435] 'process raft request'  (duration: 455.802265ms)","trace[810579435] 'compare'  (duration: 3.655313414s)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:02:10.096823Z","caller":"traceutil/trace.go:171","msg":"trace[1896797891] linearizableReadLoop","detail":"{readStateIndex:662; appliedIndex:661; }","duration":"4.036731887s","start":"2026-02-25T15:02:06.06006Z","end":"2026-02-25T15:02:10.096792Z","steps":["trace[1896797891] 'read index received'  (duration: 379.211951ms)","trace[1896797891] 'applied index is now lower than readState.Index'  (duration: 3.657516196s)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:02:10.096944Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:05.983412Z","time spent":"4.113378792s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:606 > 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-02-25T15:02:10.120893Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"4.060796331s","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":"info","ts":"2026-02-25T15:02:10.12097Z","caller":"traceutil/trace.go:171","msg":"trace[1037403405] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:635; }","duration":"4.060918694s","start":"2026-02-25T15:02:06.060031Z","end":"2026-02-25T15:02:10.120949Z","steps":["trace[1037403405] 'agreement among raft nodes before linearized reading'  (duration: 4.060714078s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:10.121072Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.060011Z","time spent":"4.061047878s","remote":"127.0.0.1:39602","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-02-25T15:02:10.121257Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.262347461s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:02:10.121366Z","caller":"traceutil/trace.go:171","msg":"trace[1303417737] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:635; }","duration":"2.262560366s","start":"2026-02-25T15:02:07.858781Z","end":"2026-02-25T15:02:10.121341Z","steps":["trace[1303417737] 'agreement among raft nodes before linearized reading'  (duration: 2.262314439s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:10.121433Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:07.858768Z","time spent":"2.262639139s","remote":"127.0.0.1:39620","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":0,"response size":29,"request content":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:02:10.121439Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.162196768s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-02-25T15:02:10.121511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"4.060404333s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"}
{"level":"warn","ts":"2026-02-25T15:02:10.121282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"3.3402731s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-02-25T15:02:10.121597Z","caller":"traceutil/trace.go:171","msg":"trace[337476323] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:635; }","duration":"4.060500336s","start":"2026-02-25T15:02:06.061077Z","end":"2026-02-25T15:02:10.121577Z","steps":["trace[337476323] 'agreement among raft nodes before linearized reading'  (duration: 4.06026195s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:10.121649Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.061065Z","time spent":"4.060570438s","remote":"127.0.0.1:39602","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":"info","ts":"2026-02-25T15:02:10.121658Z","caller":"traceutil/trace.go:171","msg":"trace[24283450] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:635; }","duration":"3.340682802s","start":"2026-02-25T15:02:06.78095Z","end":"2026-02-25T15:02:10.121633Z","steps":["trace[24283450] 'agreement among raft nodes before linearized reading'  (duration: 3.340208419s)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:10.121613Z","caller":"traceutil/trace.go:171","msg":"trace[1487797476] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:635; }","duration":"1.162465926s","start":"2026-02-25T15:02:08.959089Z","end":"2026-02-25T15:02:10.121555Z","steps":["trace[1487797476] 'agreement among raft nodes before linearized reading'  (duration: 1.161991073s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:10.121734Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.780934Z","time spent":"3.340775925s","remote":"127.0.0.1:39538","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":12,"response size":31,"request content":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true "}
{"level":"warn","ts":"2026-02-25T15:02:10.121773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"4.061713777s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"warn","ts":"2026-02-25T15:02:10.121572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"4.06147658s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-02-25T15:02:10.121834Z","caller":"traceutil/trace.go:171","msg":"trace[359123538] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:635; }","duration":"4.061799659s","start":"2026-02-25T15:02:06.060009Z","end":"2026-02-25T15:02:10.121809Z","steps":["trace[359123538] 'agreement among raft nodes before linearized reading'  (duration: 4.037025615s)","trace[359123538] 'range keys from in-memory index tree'  (duration: 24.65867ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:02:10.121866Z","caller":"traceutil/trace.go:171","msg":"trace[172869822] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:635; }","duration":"4.061834381s","start":"2026-02-25T15:02:06.060009Z","end":"2026-02-25T15:02:10.121844Z","steps":["trace[172869822] 'agreement among raft nodes before linearized reading'  (duration: 4.036942203s)","trace[172869822] 'range keys from in-memory index tree'  (duration: 24.387493ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:02:10.121918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.059986Z","time spent":"4.061891252s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-02-25T15:02:10.121961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:06.059986Z","time spent":"4.061957424s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-02-25T15:02:10.121831Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:08.959071Z","time spent":"1.162692752s","remote":"127.0.0.1:53282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"warn","ts":"2026-02-25T15:02:10.122792Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.174996292s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-02-25T15:02:10.123309Z","caller":"traceutil/trace.go:171","msg":"trace[2059794322] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:635; }","duration":"2.175531876s","start":"2026-02-25T15:02:07.947761Z","end":"2026-02-25T15:02:10.123293Z","steps":["trace[2059794322] 'agreement among raft nodes before linearized reading'  (duration: 2.173844128s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:02:10.123417Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:02:07.947749Z","time spent":"2.175651349s","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-02-25T15:02:34.497198Z","caller":"traceutil/trace.go:171","msg":"trace[781501781] transaction","detail":"{read_only:false; response_revision:818; number_of_response:1; }","duration":"124.409916ms","start":"2026-02-25T15:02:34.372735Z","end":"2026-02-25T15:02:34.497145Z","steps":["trace[781501781] 'process raft request'  (duration: 124.261129ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:02:34.506086Z","caller":"traceutil/trace.go:171","msg":"trace[2038793124] transaction","detail":"{read_only:false; response_revision:819; number_of_response:1; }","duration":"132.905715ms","start":"2026-02-25T15:02:34.373156Z","end":"2026-02-25T15:02:34.506062Z","steps":["trace[2038793124] 'process raft request'  (duration: 132.799901ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:03:10.412951Z","caller":"traceutil/trace.go:171","msg":"trace[1828814680] transaction","detail":"{read_only:false; response_revision:950; number_of_response:1; }","duration":"207.787194ms","start":"2026-02-25T15:03:10.205138Z","end":"2026-02-25T15:03:10.412925Z","steps":["trace[1828814680] 'process raft request'  (duration: 207.644575ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:10.803693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.731263ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2594527025467664507 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:943 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >>","response":"size:16"}
{"level":"info","ts":"2026-02-25T15:03:10.803759Z","caller":"traceutil/trace.go:171","msg":"trace[1996330759] linearizableReadLoop","detail":"{readStateIndex:994; appliedIndex:993; }","duration":"293.931063ms","start":"2026-02-25T15:03:10.509817Z","end":"2026-02-25T15:03:10.803748Z","steps":["trace[1996330759] 'read index received'  (duration: 59.082353ms)","trace[1996330759] 'applied index is now lower than readState.Index'  (duration: 234.84773ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:03:10.804019Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.796456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"info","ts":"2026-02-25T15:03:10.804041Z","caller":"traceutil/trace.go:171","msg":"trace[907893498] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:951; }","duration":"120.856309ms","start":"2026-02-25T15:03:10.683178Z","end":"2026-02-25T15:03:10.804034Z","steps":["trace[907893498] 'agreement among raft nodes before linearized reading'  (duration: 120.770804ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:03:10.804065Z","caller":"traceutil/trace.go:171","msg":"trace[1318479777] transaction","detail":"{read_only:false; response_revision:951; number_of_response:1; }","duration":"301.576356ms","start":"2026-02-25T15:03:10.502446Z","end":"2026-02-25T15:03:10.804023Z","steps":["trace[1318479777] 'process raft request'  (duration: 66.458069ms)","trace[1318479777] 'compare'  (duration: 234.647458ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T15:03:10.804208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.513036ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:03:10.804233Z","caller":"traceutil/trace.go:171","msg":"trace[2104601150] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:951; }","duration":"222.578239ms","start":"2026-02-25T15:03:10.581648Z","end":"2026-02-25T15:03:10.804226Z","steps":["trace[2104601150] 'agreement among raft nodes before linearized reading'  (duration: 222.540487ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:10.804294Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:10.502421Z","time spent":"301.744236ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:943 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-02-25T15:03:10.804351Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.514459ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-02-25T15:03:10.804369Z","caller":"traceutil/trace.go:171","msg":"trace[605033405] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:951; }","duration":"122.574863ms","start":"2026-02-25T15:03:10.681789Z","end":"2026-02-25T15:03:10.804364Z","steps":["trace[605033405] 'agreement among raft nodes before linearized reading'  (duration: 122.52933ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:10.804419Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.447524ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllers/\" range_end:\"/registry/controllers0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:03:10.80452Z","caller":"traceutil/trace.go:171","msg":"trace[590236028] range","detail":"{range_begin:/registry/controllers/; range_end:/registry/controllers0; response_count:0; response_revision:951; }","duration":"294.577492ms","start":"2026-02-25T15:03:10.50992Z","end":"2026-02-25T15:03:10.804498Z","steps":["trace[590236028] 'agreement among raft nodes before linearized reading'  (duration: 294.390021ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:10.804923Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.478756ms","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-02-25T15:03:10.805025Z","caller":"traceutil/trace.go:171","msg":"trace[320836441] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:951; }","duration":"295.21631ms","start":"2026-02-25T15:03:10.50979Z","end":"2026-02-25T15:03:10.805007Z","steps":["trace[320836441] 'agreement among raft nodes before linearized reading'  (duration: 294.304526ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:10.806246Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"296.386421ms","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-02-25T15:03:10.80656Z","caller":"traceutil/trace.go:171","msg":"trace[25343253] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:951; }","duration":"296.715641ms","start":"2026-02-25T15:03:10.50983Z","end":"2026-02-25T15:03:10.806546Z","steps":["trace[25343253] 'agreement among raft nodes before linearized reading'  (duration: 294.110254ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:11.081087Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.316569ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:03:11.081175Z","caller":"traceutil/trace.go:171","msg":"trace[645662860] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:955; }","duration":"119.473039ms","start":"2026-02-25T15:03:10.961681Z","end":"2026-02-25T15:03:11.081154Z","steps":["trace[645662860] 'range keys from in-memory index tree'  (duration: 119.176081ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:03:13.286122Z","caller":"traceutil/trace.go:171","msg":"trace[1696685482] transaction","detail":"{read_only:false; response_revision:960; number_of_response:1; }","duration":"432.098984ms","start":"2026-02-25T15:03:12.85399Z","end":"2026-02-25T15:03:13.286089Z","steps":["trace[1696685482] 'process raft request'  (duration: 431.824936ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:13.286323Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:12.853976Z","time spent":"432.235392ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:952 > 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-02-25T15:03:13.286364Z","caller":"traceutil/trace.go:171","msg":"trace[279473320] linearizableReadLoop","detail":"{readStateIndex:1005; appliedIndex:1002; }","duration":"390.648761ms","start":"2026-02-25T15:03:12.895688Z","end":"2026-02-25T15:03:13.286337Z","steps":["trace[279473320] 'read index received'  (duration: 390.068565ms)","trace[279473320] 'applied index is now lower than readState.Index'  (duration: 579.176µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T15:03:13.286383Z","caller":"traceutil/trace.go:171","msg":"trace[35235579] transaction","detail":"{read_only:false; response_revision:961; number_of_response:1; }","duration":"432.343258ms","start":"2026-02-25T15:03:12.854015Z","end":"2026-02-25T15:03:13.286358Z","steps":["trace[35235579] 'process raft request'  (duration: 432.010438ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:13.286573Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:12.854001Z","time spent":"432.483827ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:954 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-02-25T15:03:13.286672Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"390.978721ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.149\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-02-25T15:03:13.28672Z","caller":"traceutil/trace.go:171","msg":"trace[69375025] range","detail":"{range_begin:/registry/masterleases/199.204.45.149; range_end:; response_count:1; response_revision:962; }","duration":"391.057646ms","start":"2026-02-25T15:03:12.895647Z","end":"2026-02-25T15:03:13.286705Z","steps":["trace[69375025] 'agreement among raft nodes before linearized reading'  (duration: 390.889875ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:13.286753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:12.895631Z","time spent":"391.114769ms","remote":"127.0.0.1:39380","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":159,"request content":"key:\"/registry/masterleases/199.204.45.149\" "}
{"level":"warn","ts":"2026-02-25T15:03:13.286801Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"327.292159ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T15:03:13.286868Z","caller":"traceutil/trace.go:171","msg":"trace[325744140] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:962; }","duration":"327.394905ms","start":"2026-02-25T15:03:12.959455Z","end":"2026-02-25T15:03:13.28685Z","steps":["trace[325744140] 'agreement among raft nodes before linearized reading'  (duration: 327.279838ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:13.286918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:12.959432Z","time spent":"327.47388ms","remote":"127.0.0.1:53268","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-02-25T15:03:13.28677Z","caller":"traceutil/trace.go:171","msg":"trace[448487016] transaction","detail":"{read_only:false; response_revision:962; number_of_response:1; }","duration":"432.473907ms","start":"2026-02-25T15:03:12.854087Z","end":"2026-02-25T15:03:13.286561Z","steps":["trace[448487016] 'process raft request'  (duration: 432.142597ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:13.287329Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:12.854068Z","time spent":"433.153968ms","remote":"127.0.0.1:39602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:955 > 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-02-25T15:03:14.47036Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"510.623435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-02-25T15:03:14.470619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"926.293605ms","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-02-25T15:03:14.470767Z","caller":"traceutil/trace.go:171","msg":"trace[927722331] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:963; }","duration":"926.449635ms","start":"2026-02-25T15:03:13.544294Z","end":"2026-02-25T15:03:14.470744Z","steps":["trace[927722331] 'range keys from in-memory index tree'  (duration: 926.275425ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T15:03:14.470479Z","caller":"traceutil/trace.go:171","msg":"trace[217435604] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:963; }","duration":"510.812937ms","start":"2026-02-25T15:03:13.959639Z","end":"2026-02-25T15:03:14.470452Z","steps":["trace[217435604] 'range keys from in-memory index tree'  (duration: 510.558312ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T15:03:14.471375Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T15:03:13.959622Z","time spent":"511.732025ms","remote":"127.0.0.1:53268","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}