{"level":"warn","ts":"2026-02-18T10:12:05.159617Z","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-18T10:12:05.159868Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.104: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.19.213.104:2380","--initial-cluster=instance=https://199.19.213.104:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.104:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.104: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-18T10:12:05.159985Z","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-18T10:12:05.159999Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.104:2380"]} {"level":"info","ts":"2026-02-18T10:12:05.160024Z","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-18T10:12:05.161128Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.104:2379"]} {"level":"info","ts":"2026-02-18T10:12:05.161303Z","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":2,"max-cpu-available":2,"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.19.213.104:2380"],"listen-peer-urls":["https://199.19.213.104:2380"],"advertise-client-urls":["https://199.19.213.104:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.104:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.104: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-18T10:12:05.216394Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"54.742442ms"} {"level":"info","ts":"2026-02-18T10:12:05.384756Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"8a0c9a032e61a05a","cluster-id":"153e4a99345578f6"} {"level":"info","ts":"2026-02-18T10:12:05.384862Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a switched to configuration voters=()"} {"level":"info","ts":"2026-02-18T10:12:05.384886Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a became follower at term 0"} {"level":"info","ts":"2026-02-18T10:12:05.384896Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 8a0c9a032e61a05a [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-02-18T10:12:05.384905Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a became follower at term 1"} {"level":"info","ts":"2026-02-18T10:12:05.384947Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a switched to configuration voters=(9947495015408312410)"} {"level":"warn","ts":"2026-02-18T10:12:05.610021Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-02-18T10:12:05.819432Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-02-18T10:12:05.855678Z","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-18T10:12:05.941788Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"8a0c9a032e61a05a","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-02-18T10:12:05.951157Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"8a0c9a032e61a05a","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-02-18T10:12:05.951285Z","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-18T10:12:05.951322Z","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-18T10:12:05.951329Z","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-18T10:12:05.95202Z","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-18T10:12:05.952111Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.104:2380"} {"level":"info","ts":"2026-02-18T10:12:05.952137Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.104:2380"} {"level":"info","ts":"2026-02-18T10:12:05.95243Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"8a0c9a032e61a05a","initial-advertise-peer-urls":["https://199.19.213.104:2380"],"listen-peer-urls":["https://199.19.213.104:2380"],"advertise-client-urls":["https://199.19.213.104:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.104:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-02-18T10:12:05.952525Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-02-18T10:12:05.972187Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a switched to configuration voters=(9947495015408312410)"} {"level":"info","ts":"2026-02-18T10:12:05.972329Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"153e4a99345578f6","local-member-id":"8a0c9a032e61a05a","added-peer-id":"8a0c9a032e61a05a","added-peer-peer-urls":["https://199.19.213.104:2380"]} {"level":"info","ts":"2026-02-18T10:12:06.585586Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a is starting a new election at term 1"} {"level":"info","ts":"2026-02-18T10:12:06.585659Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a became pre-candidate at term 1"} {"level":"info","ts":"2026-02-18T10:12:06.585684Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a received MsgPreVoteResp from 8a0c9a032e61a05a at term 1"} {"level":"info","ts":"2026-02-18T10:12:06.585746Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a became candidate at term 2"} {"level":"info","ts":"2026-02-18T10:12:06.585794Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a received MsgVoteResp from 8a0c9a032e61a05a at term 2"} {"level":"info","ts":"2026-02-18T10:12:06.585837Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8a0c9a032e61a05a became leader at term 2"} {"level":"info","ts":"2026-02-18T10:12:06.58587Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 8a0c9a032e61a05a elected leader 8a0c9a032e61a05a at term 2"} {"level":"info","ts":"2026-02-18T10:12:06.595012Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-02-18T10:12:06.603589Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"8a0c9a032e61a05a","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.104:2379]}","request-path":"/0/members/8a0c9a032e61a05a/attributes","cluster-id":"153e4a99345578f6","publish-timeout":"7s"} {"level":"info","ts":"2026-02-18T10:12:06.603828Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-18T10:12:06.604306Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-18T10:12:06.604865Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-02-18T10:12:06.604889Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-02-18T10:12:06.606254Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"153e4a99345578f6","local-member-id":"8a0c9a032e61a05a","cluster-version":"3.5"} {"level":"info","ts":"2026-02-18T10:12:06.60638Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-02-18T10:12:06.606429Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-02-18T10:12:06.60761Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-02-18T10:12:06.62189Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.104:2379"} {"level":"info","ts":"2026-02-18T10:12:27.699042Z","caller":"traceutil/trace.go:171","msg":"trace[2042587352] transaction","detail":"{read_only:false; response_revision:459; number_of_response:1; }","duration":"185.792548ms","start":"2026-02-18T10:12:27.513241Z","end":"2026-02-18T10:12:27.699033Z","steps":["trace[2042587352] 'process raft request' (duration: 185.43275ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:27.698839Z","caller":"traceutil/trace.go:171","msg":"trace[442104324] linearizableReadLoop","detail":"{readStateIndex:472; appliedIndex:471; }","duration":"155.394324ms","start":"2026-02-18T10:12:27.543431Z","end":"2026-02-18T10:12:27.698825Z","steps":["trace[442104324] 'read index received' (duration: 155.187129ms)","trace[442104324] 'applied index is now lower than readState.Index' (duration: 206.685µs)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:12:27.699234Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.790644ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-18T10:12:27.699273Z","caller":"traceutil/trace.go:171","msg":"trace[27103633] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:459; }","duration":"155.861156ms","start":"2026-02-18T10:12:27.543405Z","end":"2026-02-18T10:12:27.699266Z","steps":["trace[27103633] 'agreement among raft nodes before linearized reading' (duration: 155.799115ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:38.747379Z","caller":"traceutil/trace.go:171","msg":"trace[824863859] transaction","detail":"{read_only:false; response_revision:521; number_of_response:1; }","duration":"190.84665ms","start":"2026-02-18T10:12:38.55651Z","end":"2026-02-18T10:12:38.747357Z","steps":["trace[824863859] 'process raft request' (duration: 190.715167ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:39.886049Z","caller":"traceutil/trace.go:171","msg":"trace[1034872233] transaction","detail":"{read_only:false; response_revision:539; number_of_response:1; }","duration":"114.733201ms","start":"2026-02-18T10:12:39.7713Z","end":"2026-02-18T10:12:39.886033Z","steps":["trace[1034872233] 'process raft request' (duration: 31.474393ms)","trace[1034872233] 'compare' (duration: 82.906038ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:12:39.886138Z","caller":"traceutil/trace.go:171","msg":"trace[1423582378] transaction","detail":"{read_only:false; response_revision:540; number_of_response:1; }","duration":"113.290683ms","start":"2026-02-18T10:12:39.772843Z","end":"2026-02-18T10:12:39.886134Z","steps":["trace[1423582378] 'process raft request' (duration: 112.972045ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:40.593938Z","caller":"traceutil/trace.go:171","msg":"trace[598214397] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"174.209716ms","start":"2026-02-18T10:12:40.419713Z","end":"2026-02-18T10:12:40.593922Z","steps":["trace[598214397] 'process raft request' (duration: 174.124934ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:40.9487Z","caller":"traceutil/trace.go:171","msg":"trace[1488174567] transaction","detail":"{read_only:false; response_revision:562; number_of_response:1; }","duration":"150.987479ms","start":"2026-02-18T10:12:40.797694Z","end":"2026-02-18T10:12:40.948681Z","steps":["trace[1488174567] 'process raft request' (duration: 150.835284ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:40.958351Z","caller":"traceutil/trace.go:171","msg":"trace[1166699694] transaction","detail":"{read_only:false; response_revision:563; number_of_response:1; }","duration":"141.887611ms","start":"2026-02-18T10:12:40.816444Z","end":"2026-02-18T10:12:40.958331Z","steps":["trace[1166699694] 'process raft request' (duration: 141.718426ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:42.086804Z","caller":"traceutil/trace.go:171","msg":"trace[437200918] linearizableReadLoop","detail":"{readStateIndex:587; appliedIndex:586; }","duration":"176.351612ms","start":"2026-02-18T10:12:41.910437Z","end":"2026-02-18T10:12:42.086789Z","steps":["trace[437200918] 'read index received' (duration: 176.193908ms)","trace[437200918] 'applied index is now lower than readState.Index' (duration: 157.184µs)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:12:42.086875Z","caller":"traceutil/trace.go:171","msg":"trace[1127712310] transaction","detail":"{read_only:false; response_revision:571; number_of_response:1; }","duration":"178.888708ms","start":"2026-02-18T10:12:41.907982Z","end":"2026-02-18T10:12:42.08687Z","steps":["trace[1127712310] 'process raft request' (duration: 178.715063ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:42.087133Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.683582ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-18T10:12:42.087159Z","caller":"traceutil/trace.go:171","msg":"trace[871435011] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:571; }","duration":"176.737783ms","start":"2026-02-18T10:12:41.910415Z","end":"2026-02-18T10:12:42.087153Z","steps":["trace[871435011] 'agreement among raft nodes before linearized reading' (duration: 176.64136ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:42.087224Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.28265ms","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-18T10:12:42.087235Z","caller":"traceutil/trace.go:171","msg":"trace[922405595] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:571; }","duration":"145.294121ms","start":"2026-02-18T10:12:41.941938Z","end":"2026-02-18T10:12:42.087232Z","steps":["trace[922405595] 'agreement among raft nodes before linearized reading' (duration: 145.26192ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:47.648727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.620599ms","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-18T10:12:47.64879Z","caller":"traceutil/trace.go:171","msg":"trace[1000042772] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:593; }","duration":"176.727373ms","start":"2026-02-18T10:12:47.472045Z","end":"2026-02-18T10:12:47.648773Z","steps":["trace[1000042772] 'range keys from in-memory index tree' (duration: 176.504147ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.03162Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.021882596s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-l7kwk\" ","response":"range_response_count:1 size:16656"} {"level":"info","ts":"2026-02-18T10:12:49.031686Z","caller":"traceutil/trace.go:171","msg":"trace[1109352769] range","detail":"{range_begin:/registry/pods/kube-system/cilium-l7kwk; range_end:; response_count:1; response_revision:594; }","duration":"1.021983649s","start":"2026-02-18T10:12:48.009688Z","end":"2026-02-18T10:12:49.031672Z","steps":["trace[1109352769] 'range keys from in-memory index tree' (duration: 1.021819754s)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.031709Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.009659Z","time spent":"1.022043981s","remote":"127.0.0.1:51050","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16679,"request content":"key:\"/registry/pods/kube-system/cilium-l7kwk\" "} {"level":"warn","ts":"2026-02-18T10:12:49.031884Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"900.172712ms","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-18T10:12:49.031903Z","caller":"traceutil/trace.go:171","msg":"trace[593811367] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:594; }","duration":"900.225354ms","start":"2026-02-18T10:12:48.131671Z","end":"2026-02-18T10:12:49.031897Z","steps":["trace[593811367] 'range keys from in-memory index tree' (duration: 900.051589ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.031919Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.131641Z","time spent":"900.273436ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-02-18T10:12:49.032031Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"872.281064ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-02-18T10:12:49.032047Z","caller":"traceutil/trace.go:171","msg":"trace[132040700] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:594; }","duration":"872.322834ms","start":"2026-02-18T10:12:48.159719Z","end":"2026-02-18T10:12:49.032042Z","steps":["trace[132040700] 'range keys from in-memory index tree' (duration: 872.182131ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032062Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.159702Z","time spent":"872.356765ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-02-18T10:12:49.032154Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"846.581221ms","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-18T10:12:49.032171Z","caller":"traceutil/trace.go:171","msg":"trace[2014956861] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:594; }","duration":"846.624482ms","start":"2026-02-18T10:12:48.18554Z","end":"2026-02-18T10:12:49.032165Z","steps":["trace[2014956861] 'range keys from in-memory index tree' (duration: 846.522579ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.185523Z","time spent":"846.661373ms","remote":"127.0.0.1:51122","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-18T10:12:49.032331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"745.316762ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.03235Z","caller":"traceutil/trace.go:171","msg":"trace[1036071315] range","detail":"{range_begin:/registry/cilium.io/ciliumexternalworkloads/; range_end:/registry/cilium.io/ciliumexternalworkloads0; response_count:0; response_revision:594; }","duration":"745.356033ms","start":"2026-02-18T10:12:48.286988Z","end":"2026-02-18T10:12:49.032344Z","steps":["trace[1036071315] 'count revisions from in-memory index tree' (duration: 745.273201ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032367Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.286975Z","time spent":"745.386195ms","remote":"127.0.0.1:41658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" count_only:true "} {"level":"warn","ts":"2026-02-18T10:12:49.03245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"744.617954ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.032466Z","caller":"traceutil/trace.go:171","msg":"trace[803046316] range","detail":"{range_begin:/registry/cilium.io/ciliumexternalworkloads/; range_end:/registry/cilium.io/ciliumexternalworkloads0; response_count:0; response_revision:594; }","duration":"744.668645ms","start":"2026-02-18T10:12:48.287793Z","end":"2026-02-18T10:12:49.032462Z","steps":["trace[803046316] 'range keys from in-memory index tree' (duration: 744.359168ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032483Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.287767Z","time spent":"744.711916ms","remote":"127.0.0.1:41658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":95,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" limit:10000 "} {"level":"warn","ts":"2026-02-18T10:12:49.032544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"742.020135ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.03256Z","caller":"traceutil/trace.go:171","msg":"trace[407159449] range","detail":"{range_begin:/registry/cilium.io/ciliumexternalworkloads/; range_end:/registry/cilium.io/ciliumexternalworkloads0; response_count:0; response_revision:594; }","duration":"742.070987ms","start":"2026-02-18T10:12:48.290484Z","end":"2026-02-18T10:12:49.032555Z","steps":["trace[407159449] 'range keys from in-memory index tree' (duration: 741.898582ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032577Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.290473Z","time spent":"742.099388ms","remote":"127.0.0.1:41658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":95,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" limit:500 "} {"level":"warn","ts":"2026-02-18T10:12:49.032649Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.154998ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.032666Z","caller":"traceutil/trace.go:171","msg":"trace[1640003993] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:594; }","duration":"727.187409ms","start":"2026-02-18T10:12:48.305474Z","end":"2026-02-18T10:12:49.032661Z","steps":["trace[1640003993] 'count revisions from in-memory index tree' (duration: 727.121718ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032683Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.305467Z","time spent":"727.21098ms","remote":"127.0.0.1:41670","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true "} {"level":"warn","ts":"2026-02-18T10:12:49.032788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.22435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.032804Z","caller":"traceutil/trace.go:171","msg":"trace[597129242] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:594; }","duration":"727.254711ms","start":"2026-02-18T10:12:48.305545Z","end":"2026-02-18T10:12:49.0328Z","steps":["trace[597129242] 'range keys from in-memory index tree' (duration: 727.144048ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032821Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.305539Z","time spent":"727.276991ms","remote":"127.0.0.1:41670","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" limit:10000 "} {"level":"warn","ts":"2026-02-18T10:12:49.032882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.497457ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.032898Z","caller":"traceutil/trace.go:171","msg":"trace[1016343348] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:594; }","duration":"727.542968ms","start":"2026-02-18T10:12:48.305349Z","end":"2026-02-18T10:12:49.032892Z","steps":["trace[1016343348] 'range keys from in-memory index tree' (duration: 727.21822ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.032916Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.305333Z","time spent":"727.579098ms","remote":"127.0.0.1:41670","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" limit:500 "} {"level":"warn","ts":"2026-02-18T10:12:49.032976Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"709.572387ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.032992Z","caller":"traceutil/trace.go:171","msg":"trace[1815531138] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:594; }","duration":"709.614959ms","start":"2026-02-18T10:12:48.323372Z","end":"2026-02-18T10:12:49.032987Z","steps":["trace[1815531138] 'count revisions from in-memory index tree' (duration: 709.485195ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033009Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.323358Z","time spent":"709.64526ms","remote":"127.0.0.1:41686","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true "} {"level":"warn","ts":"2026-02-18T10:12:49.033092Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"709.634209ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.033109Z","caller":"traceutil/trace.go:171","msg":"trace[1027682417] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:594; }","duration":"709.657599ms","start":"2026-02-18T10:12:48.323446Z","end":"2026-02-18T10:12:49.033103Z","steps":["trace[1027682417] 'range keys from in-memory index tree' (duration: 709.559807ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033126Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.323442Z","time spent":"709.67905ms","remote":"127.0.0.1:41686","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" limit:500 "} {"level":"warn","ts":"2026-02-18T10:12:49.033187Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"709.709321ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.033204Z","caller":"traceutil/trace.go:171","msg":"trace[184537427] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:594; }","duration":"709.732842ms","start":"2026-02-18T10:12:48.323465Z","end":"2026-02-18T10:12:49.033198Z","steps":["trace[184537427] 'range keys from in-memory index tree' (duration: 709.644569ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033222Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.323461Z","time spent":"709.755732ms","remote":"127.0.0.1:41686","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-02-18T10:12:49.033286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"701.113457ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.033302Z","caller":"traceutil/trace.go:171","msg":"trace[1897621141] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:594; }","duration":"701.129548ms","start":"2026-02-18T10:12:48.332167Z","end":"2026-02-18T10:12:49.033297Z","steps":["trace[1897621141] 'range keys from in-memory index tree' (duration: 701.074646ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033318Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.332142Z","time spent":"701.170728ms","remote":"127.0.0.1:41690","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" limit:500 "} {"level":"warn","ts":"2026-02-18T10:12:49.033393Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"701.149938ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.03341Z","caller":"traceutil/trace.go:171","msg":"trace[1240979098] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:594; }","duration":"701.175479ms","start":"2026-02-18T10:12:48.332229Z","end":"2026-02-18T10:12:49.033404Z","steps":["trace[1240979098] 'count revisions from in-memory index tree' (duration: 701.115687ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033427Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.332224Z","time spent":"701.196479ms","remote":"127.0.0.1:41690","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true "} {"level":"warn","ts":"2026-02-18T10:12:49.033494Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"701.249531ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.033509Z","caller":"traceutil/trace.go:171","msg":"trace[103036861] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:594; }","duration":"701.286181ms","start":"2026-02-18T10:12:48.332219Z","end":"2026-02-18T10:12:49.033505Z","steps":["trace[103036861] 'range keys from in-memory index tree' (duration: 701.2166ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.033527Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:48.332204Z","time spent":"701.317863ms","remote":"127.0.0.1:41690","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" limit:10000 "} {"level":"warn","ts":"2026-02-18T10:12:49.03373Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.174425ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:12:49.033747Z","caller":"traceutil/trace.go:171","msg":"trace[1016811833] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:594; }","duration":"278.227376ms","start":"2026-02-18T10:12:48.755515Z","end":"2026-02-18T10:12:49.033742Z","steps":["trace[1016811833] 'range keys from in-memory index tree' (duration: 278.069431ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:49.303128Z","caller":"traceutil/trace.go:171","msg":"trace[330693594] transaction","detail":"{read_only:false; response_revision:595; number_of_response:1; }","duration":"200.290168ms","start":"2026-02-18T10:12:49.102814Z","end":"2026-02-18T10:12:49.303104Z","steps":["trace[330693594] 'process raft request' (duration: 200.062752ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:49.434093Z","caller":"traceutil/trace.go:171","msg":"trace[296033975] linearizableReadLoop","detail":"{readStateIndex:616; appliedIndex:612; }","duration":"118.370285ms","start":"2026-02-18T10:12:49.315706Z","end":"2026-02-18T10:12:49.434076Z","steps":["trace[296033975] 'read index received' (duration: 118.119089ms)","trace[296033975] 'applied index is now lower than readState.Index' (duration: 250.566µs)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:12:49.434216Z","caller":"traceutil/trace.go:171","msg":"trace[229881673] transaction","detail":"{read_only:false; response_revision:597; number_of_response:1; }","duration":"326.593301ms","start":"2026-02-18T10:12:49.107603Z","end":"2026-02-18T10:12:49.434196Z","steps":["trace[229881673] 'process raft request' (duration: 326.368066ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.434291Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.569931ms","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-18T10:12:49.434314Z","caller":"traceutil/trace.go:171","msg":"trace[1153727235] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:599; }","duration":"118.609462ms","start":"2026-02-18T10:12:49.315698Z","end":"2026-02-18T10:12:49.434307Z","steps":["trace[1153727235] 'agreement among raft nodes before linearized reading' (duration: 118.452788ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:49.434567Z","caller":"traceutil/trace.go:171","msg":"trace[1500891339] transaction","detail":"{read_only:false; response_revision:598; number_of_response:1; }","duration":"326.866959ms","start":"2026-02-18T10:12:49.107646Z","end":"2026-02-18T10:12:49.434513Z","steps":["trace[1500891339] 'process raft request' (duration: 326.353655ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:49.434728Z","caller":"traceutil/trace.go:171","msg":"trace[1329907362] transaction","detail":"{read_only:false; response_revision:599; number_of_response:1; }","duration":"325.150394ms","start":"2026-02-18T10:12:49.109571Z","end":"2026-02-18T10:12:49.434721Z","steps":["trace[1329907362] 'process raft request' (duration: 324.463606ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.434797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:49.107596Z","time spent":"326.663313ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-18T10:12:49.435003Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:49.107643Z","time spent":"326.955841ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-18T10:12:49.435128Z","caller":"traceutil/trace.go:171","msg":"trace[233388807] transaction","detail":"{read_only:false; response_revision:596; number_of_response:1; }","duration":"332.036034ms","start":"2026-02-18T10:12:49.103085Z","end":"2026-02-18T10:12:49.435121Z","steps":["trace[233388807] 'process raft request' (duration: 330.748321ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:49.435181Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:49.103078Z","time spent":"332.082256ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-18T10:12:49.435242Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:49.109563Z","time spent":"325.180465ms","remote":"127.0.0.1:51050","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":16803,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-18T10:12:50.188811Z","caller":"traceutil/trace.go:171","msg":"trace[51339291] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"158.434983ms","start":"2026-02-18T10:12:50.030359Z","end":"2026-02-18T10:12:50.188794Z","steps":["trace[51339291] 'process raft request' (duration: 158.218468ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:51.23877Z","caller":"traceutil/trace.go:171","msg":"trace[1680642764] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"135.851462ms","start":"2026-02-18T10:12:51.102898Z","end":"2026-02-18T10:12:51.238749Z","steps":["trace[1680642764] 'process raft request' (duration: 93.083504ms)","trace[1680642764] 'compare' (duration: 42.650126ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:12:51.587687Z","caller":"traceutil/trace.go:171","msg":"trace[616236040] transaction","detail":"{read_only:false; response_revision:612; number_of_response:1; }","duration":"135.412361ms","start":"2026-02-18T10:12:51.452259Z","end":"2026-02-18T10:12:51.587671Z","steps":["trace[616236040] 'process raft request' (duration: 135.268098ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:51.588407Z","caller":"traceutil/trace.go:171","msg":"trace[1122940289] linearizableReadLoop","detail":"{readStateIndex:632; appliedIndex:629; }","duration":"132.764321ms","start":"2026-02-18T10:12:51.455634Z","end":"2026-02-18T10:12:51.588398Z","steps":["trace[1122940289] 'read index received' (duration: 131.858498ms)","trace[1122940289] 'applied index is now lower than readState.Index' (duration: 905.273µs)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:12:51.588558Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.915755ms","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-18T10:12:51.588605Z","caller":"traceutil/trace.go:171","msg":"trace[2138562535] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:614; }","duration":"133.006098ms","start":"2026-02-18T10:12:51.455593Z","end":"2026-02-18T10:12:51.588599Z","steps":["trace[2138562535] 'agreement among raft nodes before linearized reading' (duration: 132.843874ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:51.588845Z","caller":"traceutil/trace.go:171","msg":"trace[1988525142] transaction","detail":"{read_only:false; response_revision:613; number_of_response:1; }","duration":"136.409637ms","start":"2026-02-18T10:12:51.452428Z","end":"2026-02-18T10:12:51.588838Z","steps":["trace[1988525142] 'process raft request' (duration: 135.900764ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:51.588929Z","caller":"traceutil/trace.go:171","msg":"trace[484720517] transaction","detail":"{read_only:false; response_revision:614; number_of_response:1; }","duration":"134.549658ms","start":"2026-02-18T10:12:51.454373Z","end":"2026-02-18T10:12:51.588923Z","steps":["trace[484720517] 'process raft request' (duration: 133.998994ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:56.313337Z","caller":"traceutil/trace.go:171","msg":"trace[53820691] transaction","detail":"{read_only:false; response_revision:645; number_of_response:1; }","duration":"319.462854ms","start":"2026-02-18T10:12:55.993864Z","end":"2026-02-18T10:12:56.313327Z","steps":["trace[53820691] 'process raft request' (duration: 318.707295ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:12:56.313504Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:12:55.993846Z","time spent":"319.555477ms","remote":"127.0.0.1:51042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4356,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-18T10:12:56.313924Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"250.710697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-l7kwk\" ","response":"range_response_count:1 size:18075"} {"level":"info","ts":"2026-02-18T10:12:56.31399Z","caller":"traceutil/trace.go:171","msg":"trace[1836495857] range","detail":"{range_begin:/registry/pods/kube-system/cilium-l7kwk; range_end:; response_count:1; response_revision:645; }","duration":"250.83299ms","start":"2026-02-18T10:12:56.063149Z","end":"2026-02-18T10:12:56.313982Z","steps":["trace[1836495857] 'agreement among raft nodes before linearized reading' (duration: 250.668925ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:12:56.312883Z","caller":"traceutil/trace.go:171","msg":"trace[367271673] linearizableReadLoop","detail":"{readStateIndex:663; appliedIndex:662; }","duration":"249.66883ms","start":"2026-02-18T10:12:56.063198Z","end":"2026-02-18T10:12:56.312867Z","steps":["trace[367271673] 'read index received' (duration: 249.552116ms)","trace[367271673] 'applied index is now lower than readState.Index' (duration: 116.084µs)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:13:02.044467Z","caller":"traceutil/trace.go:171","msg":"trace[518590652] linearizableReadLoop","detail":"{readStateIndex:704; appliedIndex:703; }","duration":"363.455795ms","start":"2026-02-18T10:13:01.680995Z","end":"2026-02-18T10:13:02.044451Z","steps":["trace[518590652] 'read index received' (duration: 363.296501ms)","trace[518590652] 'applied index is now lower than readState.Index' (duration: 158.614µs)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:13:02.044555Z","caller":"traceutil/trace.go:171","msg":"trace[2071345291] transaction","detail":"{read_only:false; response_revision:683; number_of_response:1; }","duration":"365.214931ms","start":"2026-02-18T10:13:01.679335Z","end":"2026-02-18T10:13:02.04455Z","steps":["trace[2071345291] 'process raft request' (duration: 364.968614ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:02.044632Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:01.679314Z","time spent":"365.268123ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-18T10:13:02.044768Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"361.227087ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-02-18T10:13:02.044823Z","caller":"traceutil/trace.go:171","msg":"trace[1934324133] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:683; }","duration":"361.297409ms","start":"2026-02-18T10:13:01.683513Z","end":"2026-02-18T10:13:02.04481Z","steps":["trace[1934324133] 'agreement among raft nodes before linearized reading' (duration: 361.166266ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:02.044853Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:01.683496Z","time spent":"361.33736ms","remote":"127.0.0.1:51122","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-18T10:13:02.044862Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"286.789581ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:13:02.044897Z","caller":"traceutil/trace.go:171","msg":"trace[1679498589] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:683; }","duration":"286.860993ms","start":"2026-02-18T10:13:01.758028Z","end":"2026-02-18T10:13:02.044889Z","steps":["trace[1679498589] 'agreement among raft nodes before linearized reading' (duration: 286.815872ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:02.045011Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.312427ms","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-18T10:13:02.045032Z","caller":"traceutil/trace.go:171","msg":"trace[161153223] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:683; }","duration":"359.342927ms","start":"2026-02-18T10:13:01.685683Z","end":"2026-02-18T10:13:02.045026Z","steps":["trace[161153223] 'agreement among raft nodes before linearized reading' (duration: 359.273295ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:02.045039Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"364.031281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-18T10:13:02.045055Z","caller":"traceutil/trace.go:171","msg":"trace[474563956] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:683; }","duration":"364.071772ms","start":"2026-02-18T10:13:01.680979Z","end":"2026-02-18T10:13:02.045051Z","steps":["trace[474563956] 'agreement among raft nodes before linearized reading' (duration: 364.00002ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:02.045054Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:01.685678Z","time spent":"359.371769ms","remote":"127.0.0.1:51122","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-18T10:13:02.045069Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:01.68097Z","time spent":"364.094402ms","remote":"127.0.0.1:51122","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-18T10:13:02.307034Z","caller":"traceutil/trace.go:171","msg":"trace[318270702] transaction","detail":"{read_only:false; response_revision:684; number_of_response:1; }","duration":"256.92483ms","start":"2026-02-18T10:13:02.050089Z","end":"2026-02-18T10:13:02.307014Z","steps":["trace[318270702] 'process raft request' (duration: 256.726425ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:02.30973Z","caller":"traceutil/trace.go:171","msg":"trace[70039958] transaction","detail":"{read_only:false; response_revision:686; number_of_response:1; }","duration":"256.56373ms","start":"2026-02-18T10:13:02.053158Z","end":"2026-02-18T10:13:02.309722Z","steps":["trace[70039958] 'process raft request' (duration: 256.540409ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:02.309855Z","caller":"traceutil/trace.go:171","msg":"trace[1553658027] transaction","detail":"{read_only:false; response_revision:685; number_of_response:1; }","duration":"257.474543ms","start":"2026-02-18T10:13:02.052366Z","end":"2026-02-18T10:13:02.309841Z","steps":["trace[1553658027] 'process raft request' (duration: 257.217376ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:11.091777Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.127017ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-18T10:13:11.091857Z","caller":"traceutil/trace.go:171","msg":"trace[2020592200] linearizableReadLoop","detail":"{readStateIndex:767; appliedIndex:766; }","duration":"336.61032ms","start":"2026-02-18T10:13:10.755232Z","end":"2026-02-18T10:13:11.091842Z","steps":["trace[2020592200] 'read index received' (duration: 128.208176ms)","trace[2020592200] 'applied index is now lower than readState.Index' (duration: 208.401174ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:13:11.092013Z","caller":"traceutil/trace.go:171","msg":"trace[256314837] transaction","detail":"{read_only:false; response_revision:745; number_of_response:1; }","duration":"347.062225ms","start":"2026-02-18T10:13:10.744943Z","end":"2026-02-18T10:13:11.092005Z","steps":["trace[256314837] 'process raft request' (duration: 138.550037ms)","trace[256314837] 'compare' (duration: 208.048905ms)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:13:11.092067Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:10.744912Z","time spent":"347.132236ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-18T10:13:11.092201Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"336.959449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:13:11.092219Z","caller":"traceutil/trace.go:171","msg":"trace[273258527] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:745; }","duration":"337.014701ms","start":"2026-02-18T10:13:10.755198Z","end":"2026-02-18T10:13:11.092213Z","steps":["trace[273258527] 'agreement among raft nodes before linearized reading' (duration: 336.9754ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:11.092237Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:10.755182Z","time spent":"337.051711ms","remote":"127.0.0.1:50856","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-02-18T10:13:11.140898Z","caller":"traceutil/trace.go:171","msg":"trace[1429850259] transaction","detail":"{read_only:false; response_revision:746; number_of_response:1; }","duration":"319.038981ms","start":"2026-02-18T10:13:10.821843Z","end":"2026-02-18T10:13:11.140882Z","steps":["trace[1429850259] 'process raft request' (duration: 318.934158ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:11.14103Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:10.821812Z","time spent":"319.152123ms","remote":"127.0.0.1:50938","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":815,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-02-18T10:13:11.141265Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.802966ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.104\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-02-18T10:13:11.141386Z","caller":"traceutil/trace.go:171","msg":"trace[728753666] range","detail":"{range_begin:/registry/masterleases/199.19.213.104; range_end:; response_count:1; response_revision:746; }","duration":"200.867588ms","start":"2026-02-18T10:13:10.940416Z","end":"2026-02-18T10:13:11.141283Z","steps":["trace[728753666] 'agreement among raft nodes before linearized reading' (duration: 200.658713ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:11.14182Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.101999ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:13:11.143591Z","caller":"traceutil/trace.go:171","msg":"trace[105368816] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:746; }","duration":"117.906436ms","start":"2026-02-18T10:13:11.025672Z","end":"2026-02-18T10:13:11.143578Z","steps":["trace[105368816] 'agreement among raft nodes before linearized reading' (duration: 116.12139ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:24.5725Z","caller":"traceutil/trace.go:171","msg":"trace[567256479] transaction","detail":"{read_only:false; response_revision:790; number_of_response:1; }","duration":"129.460318ms","start":"2026-02-18T10:13:24.443022Z","end":"2026-02-18T10:13:24.572482Z","steps":["trace[567256479] 'process raft request' (duration: 129.15274ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:24.6873Z","caller":"traceutil/trace.go:171","msg":"trace[775703776] transaction","detail":"{read_only:false; response_revision:791; number_of_response:1; }","duration":"105.951223ms","start":"2026-02-18T10:13:24.581324Z","end":"2026-02-18T10:13:24.687275Z","steps":["trace[775703776] 'process raft request' (duration: 98.536508ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:24.744975Z","caller":"traceutil/trace.go:171","msg":"trace[174309348] transaction","detail":"{read_only:false; response_revision:792; number_of_response:1; }","duration":"162.319199ms","start":"2026-02-18T10:13:24.582631Z","end":"2026-02-18T10:13:24.74495Z","steps":["trace[174309348] 'process raft request' (duration: 161.308703ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:25.708091Z","caller":"traceutil/trace.go:171","msg":"trace[669102191] transaction","detail":"{read_only:false; response_revision:793; number_of_response:1; }","duration":"249.969673ms","start":"2026-02-18T10:13:25.458088Z","end":"2026-02-18T10:13:25.708057Z","steps":["trace[669102191] 'process raft request' (duration: 249.774968ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:46.067632Z","caller":"traceutil/trace.go:171","msg":"trace[1237149810] transaction","detail":"{read_only:false; response_revision:910; number_of_response:1; }","duration":"264.78637ms","start":"2026-02-18T10:13:45.80279Z","end":"2026-02-18T10:13:46.067576Z","steps":["trace[1237149810] 'process raft request' (duration: 264.348818ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:46.73438Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"468.290926ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-02-18T10:13:46.73451Z","caller":"traceutil/trace.go:171","msg":"trace[156837556] linearizableReadLoop","detail":"{readStateIndex:942; appliedIndex:941; }","duration":"455.079681ms","start":"2026-02-18T10:13:46.279411Z","end":"2026-02-18T10:13:46.734491Z","steps":["trace[156837556] 'read index received' (duration: 50.161µs)","trace[156837556] 'applied index is now lower than readState.Index' (duration: 455.02794ms)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:13:46.73482Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"455.392709ms","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-18T10:13:46.734917Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"299.091919ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-02-18T10:13:46.73498Z","caller":"traceutil/trace.go:171","msg":"trace[623378143] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:910; }","duration":"299.174581ms","start":"2026-02-18T10:13:46.435796Z","end":"2026-02-18T10:13:46.73497Z","steps":["trace[623378143] 'agreement among raft nodes before linearized reading' (duration: 299.044687ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:46.736295Z","caller":"traceutil/trace.go:171","msg":"trace[1048812603] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:910; }","duration":"456.875298ms","start":"2026-02-18T10:13:46.279405Z","end":"2026-02-18T10:13:46.73628Z","steps":["trace[1048812603] 'agreement among raft nodes before linearized reading' (duration: 455.262016ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:13:46.736508Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:13:46.279339Z","time spent":"457.057932ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-02-18T10:13:54.34962Z","caller":"traceutil/trace.go:171","msg":"trace[2092230546] transaction","detail":"{read_only:false; response_revision:932; number_of_response:1; }","duration":"184.776517ms","start":"2026-02-18T10:13:54.164802Z","end":"2026-02-18T10:13:54.349579Z","steps":["trace[2092230546] 'process raft request' (duration: 184.571952ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:13:58.541053Z","caller":"traceutil/trace.go:171","msg":"trace[655111428] transaction","detail":"{read_only:false; response_revision:943; number_of_response:1; }","duration":"127.178369ms","start":"2026-02-18T10:13:58.41385Z","end":"2026-02-18T10:13:58.541028Z","steps":["trace[655111428] 'process raft request' (duration: 127.009604ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:03.033249Z","caller":"traceutil/trace.go:171","msg":"trace[209690897] transaction","detail":"{read_only:false; response_revision:972; number_of_response:1; }","duration":"107.802521ms","start":"2026-02-18T10:14:02.925425Z","end":"2026-02-18T10:14:03.033228Z","steps":["trace[209690897] 'process raft request' (duration: 107.472973ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:03.213686Z","caller":"traceutil/trace.go:171","msg":"trace[1097612782] transaction","detail":"{read_only:false; response_revision:973; number_of_response:1; }","duration":"173.476431ms","start":"2026-02-18T10:14:03.040188Z","end":"2026-02-18T10:14:03.213665Z","steps":["trace[1097612782] 'process raft request' (duration: 81.733999ms)","trace[1097612782] 'compare' (duration: 91.531696ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:14:03.277896Z","caller":"traceutil/trace.go:171","msg":"trace[2115632477] transaction","detail":"{read_only:false; response_revision:975; number_of_response:1; }","duration":"215.960883ms","start":"2026-02-18T10:14:03.0619Z","end":"2026-02-18T10:14:03.277861Z","steps":["trace[2115632477] 'process raft request' (duration: 215.900812ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:03.279591Z","caller":"traceutil/trace.go:171","msg":"trace[2066485325] transaction","detail":"{read_only:false; response_revision:974; number_of_response:1; }","duration":"237.373282ms","start":"2026-02-18T10:14:03.042198Z","end":"2026-02-18T10:14:03.279571Z","steps":["trace[2066485325] 'process raft request' (duration: 235.408042ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:13.519285Z","caller":"traceutil/trace.go:171","msg":"trace[440133554] transaction","detail":"{read_only:false; response_revision:1051; number_of_response:1; }","duration":"102.529913ms","start":"2026-02-18T10:14:13.41673Z","end":"2026-02-18T10:14:13.51926Z","steps":["trace[440133554] 'process raft request' (duration: 42.78843ms)","trace[440133554] 'compare' (duration: 59.551939ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:14:15.255868Z","caller":"traceutil/trace.go:171","msg":"trace[1118260458] transaction","detail":"{read_only:false; response_revision:1055; number_of_response:1; }","duration":"103.852488ms","start":"2026-02-18T10:14:15.151995Z","end":"2026-02-18T10:14:15.255847Z","steps":["trace[1118260458] 'process raft request' (duration: 94.434532ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:14:15.567233Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.030858ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-02-18T10:14:15.567614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.115627ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-02-18T10:14:15.569889Z","caller":"traceutil/trace.go:171","msg":"trace[1773387569] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1056; }","duration":"177.131481ms","start":"2026-02-18T10:14:15.39014Z","end":"2026-02-18T10:14:15.567272Z","steps":["trace[1773387569] 'range keys from in-memory index tree' (duration: 176.828593ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:15.569904Z","caller":"traceutil/trace.go:171","msg":"trace[852555006] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1056; }","duration":"149.21714ms","start":"2026-02-18T10:14:15.418456Z","end":"2026-02-18T10:14:15.567673Z","steps":["trace[852555006] 'range keys from in-memory index tree' (duration: 148.986324ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:15.57553Z","caller":"traceutil/trace.go:171","msg":"trace[1908817599] transaction","detail":"{read_only:false; response_revision:1057; number_of_response:1; }","duration":"133.417516ms","start":"2026-02-18T10:14:15.442102Z","end":"2026-02-18T10:14:15.575519Z","steps":["trace[1908817599] 'process raft request' (duration: 133.326143ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:14:15.947781Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.651981ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-18T10:14:15.947877Z","caller":"traceutil/trace.go:171","msg":"trace[680078660] linearizableReadLoop","detail":"{readStateIndex:1097; appliedIndex:1096; }","duration":"192.581303ms","start":"2026-02-18T10:14:15.755279Z","end":"2026-02-18T10:14:15.94786Z","steps":["trace[680078660] 'read index received' (duration: 11.724067ms)","trace[680078660] 'applied index is now lower than readState.Index' (duration: 180.856206ms)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:14:15.948564Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.275521ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:14:15.948612Z","caller":"traceutil/trace.go:171","msg":"trace[502950984] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1060; }","duration":"193.355122ms","start":"2026-02-18T10:14:15.755245Z","end":"2026-02-18T10:14:15.9486Z","steps":["trace[502950984] 'agreement among raft nodes before linearized reading' (duration: 193.037654ms)"],"step_count":1} {"level":"info","ts":"2026-02-18T10:14:15.948878Z","caller":"traceutil/trace.go:171","msg":"trace[2037241485] transaction","detail":"{read_only:false; response_revision:1060; number_of_response:1; }","duration":"366.002066ms","start":"2026-02-18T10:14:15.582834Z","end":"2026-02-18T10:14:15.948836Z","steps":["trace[2037241485] 'process raft request' (duration: 184.227815ms)","trace[2037241485] 'compare' (duration: 180.472057ms)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:14:15.949163Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-18T10:14:15.582818Z","time spent":"366.237361ms","remote":"127.0.0.1:51122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-18T10:14:29.589936Z","caller":"traceutil/trace.go:171","msg":"trace[1330133433] transaction","detail":"{read_only:false; response_revision:1121; number_of_response:1; }","duration":"189.125972ms","start":"2026-02-18T10:14:29.400776Z","end":"2026-02-18T10:14:29.589902Z","steps":["trace[1330133433] 'process raft request' (duration: 130.37006ms)","trace[1330133433] 'compare' (duration: 58.66582ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:17:02.599696Z","caller":"traceutil/trace.go:171","msg":"trace[2069297409] linearizableReadLoop","detail":"{readStateIndex:1891; appliedIndex:1890; }","duration":"119.267278ms","start":"2026-02-18T10:17:02.480407Z","end":"2026-02-18T10:17:02.599674Z","steps":["trace[2069297409] 'read index received' (duration: 67.173399ms)","trace[2069297409] 'applied index is now lower than readState.Index' (duration: 52.092929ms)"],"step_count":2} {"level":"info","ts":"2026-02-18T10:17:02.600221Z","caller":"traceutil/trace.go:171","msg":"trace[684403138] transaction","detail":"{read_only:false; response_revision:1820; number_of_response:1; }","duration":"120.678105ms","start":"2026-02-18T10:17:02.479526Z","end":"2026-02-18T10:17:02.600205Z","steps":["trace[684403138] 'process raft request' (duration: 68.103363ms)","trace[684403138] 'compare' (duration: 51.956356ms)"],"step_count":2} {"level":"warn","ts":"2026-02-18T10:17:02.60051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.417433ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-18T10:17:02.600547Z","caller":"traceutil/trace.go:171","msg":"trace[1264097789] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:1820; }","duration":"120.147862ms","start":"2026-02-18T10:17:02.480388Z","end":"2026-02-18T10:17:02.600536Z","steps":["trace[1264097789] 'agreement among raft nodes before linearized reading' (duration: 119.387922ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:17:02.843654Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.231892ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-02-18T10:17:02.843807Z","caller":"traceutil/trace.go:171","msg":"trace[806772995] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1821; }","duration":"108.767557ms","start":"2026-02-18T10:17:02.735019Z","end":"2026-02-18T10:17:02.843787Z","steps":["trace[806772995] 'range keys from in-memory index tree' (duration: 108.048348ms)"],"step_count":1} {"level":"warn","ts":"2026-02-18T10:17:34.433532Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.95684ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-02-18T10:17:34.433612Z","caller":"traceutil/trace.go:171","msg":"trace[1816625235] transaction","detail":"{read_only:false; response_revision:1995; number_of_response:1; }","duration":"180.336472ms","start":"2026-02-18T10:17:34.253262Z","end":"2026-02-18T10:17:34.433599Z","steps":["trace[1816625235] 'process raft request' (duration: 35.255919ms)","trace[1816625235] 'compare' (duration: 144.741535ms)"],"step_count":2}