{"level":"warn","ts":"2026-04-14T07:47:23.37857Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-14T07:47:23.378644Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.30: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.30:2380","--initial-cluster=instance=https://199.204.45.30:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.30:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.30:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-04-14T07:47:23.378704Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-14T07:47:23.378717Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.30:2380"]} {"level":"info","ts":"2026-04-14T07:47:23.378746Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-14T07:47:23.37937Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.30:2379"]} {"level":"info","ts":"2026-04-14T07:47:23.37945Z","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.30:2380"],"listen-peer-urls":["https://199.204.45.30:2380"],"advertise-client-urls":["https://199.204.45.30:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.30:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.30:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-04-14T07:47:23.383421Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.776925ms"} {"level":"info","ts":"2026-04-14T07:47:23.390191Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"c6cf68dde442ffa5","cluster-id":"98b7ecdca9045526"} {"level":"info","ts":"2026-04-14T07:47:23.390296Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 switched to configuration voters=()"} {"level":"info","ts":"2026-04-14T07:47:23.390501Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 became follower at term 0"} {"level":"info","ts":"2026-04-14T07:47:23.39052Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft c6cf68dde442ffa5 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-14T07:47:23.390529Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 became follower at term 1"} {"level":"info","ts":"2026-04-14T07:47:23.390567Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 switched to configuration voters=(14325784241915494309)"} {"level":"warn","ts":"2026-04-14T07:47:23.401607Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-14T07:47:23.403888Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-14T07:47:23.417805Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-04-14T07:47:23.422099Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"c6cf68dde442ffa5","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-14T07:47:23.422319Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"c6cf68dde442ffa5","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-14T07:47:23.422353Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T07:47:23.422544Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T07:47:23.422595Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T07:47:23.424704Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 switched to configuration voters=(14325784241915494309)"} {"level":"info","ts":"2026-04-14T07:47:23.424845Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"98b7ecdca9045526","local-member-id":"c6cf68dde442ffa5","added-peer-id":"c6cf68dde442ffa5","added-peer-peer-urls":["https://199.204.45.30:2380"]} {"level":"info","ts":"2026-04-14T07:47:23.427141Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-14T07:47:23.427255Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.30:2380"} {"level":"info","ts":"2026-04-14T07:47:23.427301Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.30:2380"} {"level":"info","ts":"2026-04-14T07:47:23.427385Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"c6cf68dde442ffa5","initial-advertise-peer-urls":["https://199.204.45.30:2380"],"listen-peer-urls":["https://199.204.45.30:2380"],"advertise-client-urls":["https://199.204.45.30:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.30:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-14T07:47:23.427424Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-14T07:47:24.091224Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 is starting a new election at term 1"} {"level":"info","ts":"2026-04-14T07:47:24.09129Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-14T07:47:24.091338Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 received MsgPreVoteResp from c6cf68dde442ffa5 at term 1"} {"level":"info","ts":"2026-04-14T07:47:24.091377Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 became candidate at term 2"} {"level":"info","ts":"2026-04-14T07:47:24.0914Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 received MsgVoteResp from c6cf68dde442ffa5 at term 2"} {"level":"info","ts":"2026-04-14T07:47:24.091423Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c6cf68dde442ffa5 became leader at term 2"} {"level":"info","ts":"2026-04-14T07:47:24.091447Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: c6cf68dde442ffa5 elected leader c6cf68dde442ffa5 at term 2"} {"level":"info","ts":"2026-04-14T07:47:24.092356Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"c6cf68dde442ffa5","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.30:2379]}","request-path":"/0/members/c6cf68dde442ffa5/attributes","cluster-id":"98b7ecdca9045526","publish-timeout":"7s"} {"level":"info","ts":"2026-04-14T07:47:24.092935Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T07:47:24.092949Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T07:47:24.09309Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T07:47:24.093367Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-14T07:47:24.093389Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-14T07:47:24.09405Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"98b7ecdca9045526","local-member-id":"c6cf68dde442ffa5","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T07:47:24.094185Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T07:47:24.094248Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T07:47:24.096034Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-14T07:47:24.118226Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.30:2379"} {"level":"warn","ts":"2026-04-14T07:47:26.042486Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"270.85769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-04-14T07:47:26.042586Z","caller":"traceutil/trace.go:171","msg":"trace[1491698866] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:0; response_revision:73; }","duration":"271.019435ms","start":"2026-04-14T07:47:25.77154Z","end":"2026-04-14T07:47:26.04256Z","steps":["trace[1491698866] 'range keys from in-memory index tree' (duration: 270.722998ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:28.572594Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.282464ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/node-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:47:28.572689Z","caller":"traceutil/trace.go:171","msg":"trace[1857122761] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/node-controller; range_end:; response_count:0; response_revision:228; }","duration":"225.424948ms","start":"2026-04-14T07:47:28.347246Z","end":"2026-04-14T07:47:28.572671Z","steps":["trace[1857122761] 'range keys from in-memory index tree' (duration: 225.171351ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:29.07564Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980079662,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-14T07:47:29.145604Z","caller":"traceutil/trace.go:171","msg":"trace[158749404] transaction","detail":"{read_only:false; response_revision:229; number_of_response:1; }","duration":"596.821686ms","start":"2026-04-14T07:47:28.548752Z","end":"2026-04-14T07:47:29.145573Z","steps":["trace[158749404] 'process raft request' (duration: 596.668662ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:29.146261Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:47:28.548721Z","time spent":"596.970599ms","remote":"127.0.0.1:50148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5877,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T07:47:30.038238Z","caller":"traceutil/trace.go:171","msg":"trace[1859734897] linearizableReadLoop","detail":"{readStateIndex:236; appliedIndex:234; }","duration":"1.462693203s","start":"2026-04-14T07:47:28.57552Z","end":"2026-04-14T07:47:30.038213Z","steps":["trace[1859734897] 'read index received' (duration: 569.802462ms)","trace[1859734897] 'applied index is now lower than readState.Index' (duration: 892.889551ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:47:30.038408Z","caller":"traceutil/trace.go:171","msg":"trace[768146618] transaction","detail":"{read_only:false; response_revision:230; number_of_response:1; }","duration":"1.458574558s","start":"2026-04-14T07:47:28.579789Z","end":"2026-04-14T07:47:30.038364Z","steps":["trace[768146618] 'process raft request' (duration: 1.454356542s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:30.038476Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.462934988s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-04-14T07:47:30.038527Z","caller":"traceutil/trace.go:171","msg":"trace[1122397770] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:230; }","duration":"1.46302593s","start":"2026-04-14T07:47:28.575479Z","end":"2026-04-14T07:47:30.038505Z","steps":["trace[1122397770] 'agreement among raft nodes before linearized reading' (duration: 1.462932747s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:30.038561Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:47:28.575459Z","time spent":"1.463095232s","remote":"127.0.0.1:50060","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":1,"response size":375,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-04-14T07:47:30.038541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.114252ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:47:30.038575Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"463.693708ms","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-04-14T07:47:30.038639Z","caller":"traceutil/trace.go:171","msg":"trace[2005955555] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:230; }","duration":"287.420269ms","start":"2026-04-14T07:47:29.751183Z","end":"2026-04-14T07:47:30.038604Z","steps":["trace[2005955555] 'agreement among raft nodes before linearized reading' (duration: 287.275275ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:30.038671Z","caller":"traceutil/trace.go:171","msg":"trace[1685250583] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:230; }","duration":"463.858992ms","start":"2026-04-14T07:47:29.57479Z","end":"2026-04-14T07:47:30.038649Z","steps":["trace[1685250583] 'agreement among raft nodes before linearized reading' (duration: 463.656497ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:30.03872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:47:29.574769Z","time spent":"463.941744ms","remote":"127.0.0.1:50200","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-04-14T07:47:30.038873Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:47:28.579762Z","time spent":"1.458752693s","remote":"127.0.0.1:50136","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4002,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:47:30.03951Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"463.896172ms","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-04-14T07:47:30.039787Z","caller":"traceutil/trace.go:171","msg":"trace[1550751336] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:230; }","duration":"464.139448ms","start":"2026-04-14T07:47:29.575563Z","end":"2026-04-14T07:47:30.039702Z","steps":["trace[1550751336] 'agreement among raft nodes before linearized reading' (duration: 463.289389ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:47:30.040084Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:47:29.57555Z","time spent":"464.515707ms","remote":"127.0.0.1:50200","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":"warn","ts":"2026-04-14T07:47:31.339191Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.00573ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:47:31.33928Z","caller":"traceutil/trace.go:171","msg":"trace[825073388] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ttl-controller; range_end:; response_count:0; response_revision:282; }","duration":"240.138563ms","start":"2026-04-14T07:47:31.09912Z","end":"2026-04-14T07:47:31.339258Z","steps":["trace[825073388] 'range keys from in-memory index tree' (duration: 239.943089ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.239935Z","caller":"traceutil/trace.go:171","msg":"trace[844465107] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"243.478008ms","start":"2026-04-14T07:47:54.99643Z","end":"2026-04-14T07:47:55.239908Z","steps":["trace[844465107] 'process raft request' (duration: 243.337255ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278222Z","caller":"traceutil/trace.go:171","msg":"trace[246547198] transaction","detail":"{read_only:false; response_revision:475; number_of_response:1; }","duration":"271.903434ms","start":"2026-04-14T07:47:55.00628Z","end":"2026-04-14T07:47:55.278183Z","steps":["trace[246547198] 'process raft request' (duration: 271.70917ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278409Z","caller":"traceutil/trace.go:171","msg":"trace[231637909] transaction","detail":"{read_only:false; response_revision:478; number_of_response:1; }","duration":"267.28248ms","start":"2026-04-14T07:47:55.011093Z","end":"2026-04-14T07:47:55.278375Z","steps":["trace[231637909] 'process raft request' (duration: 267.074195ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278527Z","caller":"traceutil/trace.go:171","msg":"trace[1340871987] transaction","detail":"{read_only:false; response_revision:480; number_of_response:1; }","duration":"267.287581ms","start":"2026-04-14T07:47:55.01123Z","end":"2026-04-14T07:47:55.278517Z","steps":["trace[1340871987] 'process raft request' (duration: 267.009174ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278597Z","caller":"traceutil/trace.go:171","msg":"trace[341807772] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"259.35545ms","start":"2026-04-14T07:47:55.019222Z","end":"2026-04-14T07:47:55.278577Z","steps":["trace[341807772] 'process raft request' (duration: 259.055822ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278777Z","caller":"traceutil/trace.go:171","msg":"trace[213192954] transaction","detail":"{read_only:false; response_revision:477; number_of_response:1; }","duration":"267.652719ms","start":"2026-04-14T07:47:55.011084Z","end":"2026-04-14T07:47:55.278736Z","steps":["trace[213192954] 'process raft request' (duration: 267.045794ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278736Z","caller":"traceutil/trace.go:171","msg":"trace[362395246] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"271.364393ms","start":"2026-04-14T07:47:55.007338Z","end":"2026-04-14T07:47:55.278703Z","steps":["trace[362395246] 'process raft request' (duration: 270.751788ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.27848Z","caller":"traceutil/trace.go:171","msg":"trace[297124253] transaction","detail":"{read_only:false; response_revision:474; number_of_response:1; }","duration":"272.422257ms","start":"2026-04-14T07:47:55.006034Z","end":"2026-04-14T07:47:55.278457Z","steps":["trace[297124253] 'process raft request' (duration: 271.839143ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278976Z","caller":"traceutil/trace.go:171","msg":"trace[504932067] transaction","detail":"{read_only:false; response_revision:482; number_of_response:1; }","duration":"241.552085ms","start":"2026-04-14T07:47:55.03738Z","end":"2026-04-14T07:47:55.278932Z","steps":["trace[504932067] 'process raft request' (duration: 241.025303ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.278462Z","caller":"traceutil/trace.go:171","msg":"trace[573651701] transaction","detail":"{read_only:false; response_revision:479; number_of_response:1; }","duration":"267.285061ms","start":"2026-04-14T07:47:55.01115Z","end":"2026-04-14T07:47:55.278435Z","steps":["trace[573651701] 'process raft request' (duration: 267.055505ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.279153Z","caller":"traceutil/trace.go:171","msg":"trace[1873548530] transaction","detail":"{read_only:false; response_revision:483; number_of_response:1; }","duration":"235.878415ms","start":"2026-04-14T07:47:55.043264Z","end":"2026-04-14T07:47:55.279143Z","steps":["trace[1873548530] 'process raft request' (duration: 235.417954ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.279146Z","caller":"traceutil/trace.go:171","msg":"trace[1688928678] transaction","detail":"{read_only:false; response_revision:484; number_of_response:1; }","duration":"103.76846ms","start":"2026-04-14T07:47:55.175351Z","end":"2026-04-14T07:47:55.279119Z","steps":["trace[1688928678] 'process raft request' (duration: 103.573766ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.533981Z","caller":"traceutil/trace.go:171","msg":"trace[1868885415] transaction","detail":"{read_only:false; response_revision:502; number_of_response:1; }","duration":"142.713036ms","start":"2026-04-14T07:47:55.391244Z","end":"2026-04-14T07:47:55.533957Z","steps":["trace[1868885415] 'process raft request' (duration: 133.351593ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.534409Z","caller":"traceutil/trace.go:171","msg":"trace[506281423] transaction","detail":"{read_only:false; response_revision:504; number_of_response:1; }","duration":"128.253288ms","start":"2026-04-14T07:47:55.40614Z","end":"2026-04-14T07:47:55.534393Z","steps":["trace[506281423] 'process raft request' (duration: 127.804848ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:47:55.537472Z","caller":"traceutil/trace.go:171","msg":"trace[1485381716] transaction","detail":"{read_only:false; response_revision:503; number_of_response:1; }","duration":"130.650132ms","start":"2026-04-14T07:47:55.403885Z","end":"2026-04-14T07:47:55.534535Z","steps":["trace[1485381716] 'process raft request' (duration: 129.999517ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:01.750828Z","caller":"traceutil/trace.go:171","msg":"trace[530763622] linearizableReadLoop","detail":"{readStateIndex:600; appliedIndex:599; }","duration":"100.954976ms","start":"2026-04-14T07:48:01.649845Z","end":"2026-04-14T07:48:01.7508Z","steps":["trace[530763622] 'read index received' (duration: 100.749582ms)","trace[530763622] 'applied index is now lower than readState.Index' (duration: 204.284µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:48:01.75088Z","caller":"traceutil/trace.go:171","msg":"trace[39977402] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"124.558964ms","start":"2026-04-14T07:48:01.62629Z","end":"2026-04-14T07:48:01.750849Z","steps":["trace[39977402] 'process raft request' (duration: 124.344709ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:01.750972Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.11412ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:01.751009Z","caller":"traceutil/trace.go:171","msg":"trace[1192495877] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:582; }","duration":"101.215983ms","start":"2026-04-14T07:48:01.649781Z","end":"2026-04-14T07:48:01.750997Z","steps":["trace[1192495877] 'agreement among raft nodes before linearized reading' (duration: 101.132811ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:02.654445Z","caller":"traceutil/trace.go:171","msg":"trace[2090764346] linearizableReadLoop","detail":"{readStateIndex:601; appliedIndex:600; }","duration":"425.327515ms","start":"2026-04-14T07:48:02.229093Z","end":"2026-04-14T07:48:02.654421Z","steps":["trace[2090764346] 'read index received' (duration: 424.621428ms)","trace[2090764346] 'applied index is now lower than readState.Index' (duration: 705.037µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:48:02.65454Z","caller":"traceutil/trace.go:171","msg":"trace[1308153065] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"808.088102ms","start":"2026-04-14T07:48:01.846426Z","end":"2026-04-14T07:48:02.654514Z","steps":["trace[1308153065] 'process raft request' (duration: 807.416726ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:02.654634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"425.529399ms","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-04-14T07:48:02.654668Z","caller":"traceutil/trace.go:171","msg":"trace[1287481366] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:583; }","duration":"425.57826ms","start":"2026-04-14T07:48:02.22908Z","end":"2026-04-14T07:48:02.654658Z","steps":["trace[1287481366] 'agreement among raft nodes before linearized reading' (duration: 425.456058ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:02.654706Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.229019Z","time spent":"425.678502ms","remote":"127.0.0.1:50200","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-04-14T07:48:02.654736Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:01.846388Z","time spent":"808.270366ms","remote":"127.0.0.1:50034","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036313,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:48:03.364097Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"573.718341ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-04-14T07:48:03.36419Z","caller":"traceutil/trace.go:171","msg":"trace[1079403755] linearizableReadLoop","detail":"{readStateIndex:602; appliedIndex:601; }","duration":"709.667533ms","start":"2026-04-14T07:48:02.654509Z","end":"2026-04-14T07:48:03.364177Z","steps":["trace[1079403755] 'read index received' (duration: 135.703566ms)","trace[1079403755] 'applied index is now lower than readState.Index' (duration: 573.962997ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:48:03.364269Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"714.243517ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.364282Z","caller":"traceutil/trace.go:171","msg":"trace[8299423] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:583; }","duration":"714.302438ms","start":"2026-04-14T07:48:02.649975Z","end":"2026-04-14T07:48:03.364277Z","steps":["trace[8299423] 'agreement among raft nodes before linearized reading' (duration: 714.263837ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.364301Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.649943Z","time spent":"714.353889ms","remote":"127.0.0.1:49962","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-04-14T07:48:03.364521Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.12278763s","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-04-14T07:48:03.364534Z","caller":"traceutil/trace.go:171","msg":"trace[1954461946] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:583; }","duration":"1.12281021s","start":"2026-04-14T07:48:02.24172Z","end":"2026-04-14T07:48:03.36453Z","steps":["trace[1954461946] 'agreement among raft nodes before linearized reading' (duration: 1.122743359s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.364545Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.241715Z","time spent":"1.122827721s","remote":"127.0.0.1:50200","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-04-14T07:48:03.36457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.126567346s","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-04-14T07:48:03.364605Z","caller":"traceutil/trace.go:171","msg":"trace[1134004876] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:583; }","duration":"1.126637808s","start":"2026-04-14T07:48:02.237948Z","end":"2026-04-14T07:48:03.364586Z","steps":["trace[1134004876] 'agreement among raft nodes before linearized reading' (duration: 1.126569926s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.364623Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.237929Z","time spent":"1.126689228s","remote":"127.0.0.1:50200","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-04-14T07:48:03.364827Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.123374634s","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-04-14T07:48:03.36493Z","caller":"traceutil/trace.go:171","msg":"trace[598110910] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:583; }","duration":"1.123514736s","start":"2026-04-14T07:48:02.241401Z","end":"2026-04-14T07:48:03.364916Z","steps":["trace[598110910] 'agreement among raft nodes before linearized reading' (duration: 1.123287041s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.364979Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.241387Z","time spent":"1.123585718s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-04-14T07:48:03.382453Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.189523ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.382516Z","caller":"traceutil/trace.go:171","msg":"trace[1743852437] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:585; }","duration":"269.280985ms","start":"2026-04-14T07:48:03.113222Z","end":"2026-04-14T07:48:03.382503Z","steps":["trace[1743852437] 'agreement among raft nodes before linearized reading' (duration: 269.183533ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.382549Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.118848ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.382715Z","caller":"traceutil/trace.go:171","msg":"trace[623640530] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:585; }","duration":"268.317652ms","start":"2026-04-14T07:48:03.114305Z","end":"2026-04-14T07:48:03.382622Z","steps":["trace[623640530] 'agreement among raft nodes before linearized reading' (duration: 268.106228ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.382802Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.503431ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.382857Z","caller":"traceutil/trace.go:171","msg":"trace[1859607851] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:585; }","duration":"451.569942ms","start":"2026-04-14T07:48:02.931272Z","end":"2026-04-14T07:48:03.382842Z","steps":["trace[1859607851] 'agreement among raft nodes before linearized reading' (duration: 451.48735ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.382855Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"580.807863ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:03.382891Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.931215Z","time spent":"451.668274ms","remote":"127.0.0.1:50658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.382884Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"580.645769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:03.382931Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"604.792217ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:03.382945Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.128636ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.383506Z","caller":"traceutil/trace.go:171","msg":"trace[1154175344] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:585; }","duration":"154.717469ms","start":"2026-04-14T07:48:03.228781Z","end":"2026-04-14T07:48:03.383498Z","steps":["trace[1154175344] 'agreement among raft nodes before linearized reading' (duration: 154.087375ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:03.382898Z","caller":"traceutil/trace.go:171","msg":"trace[803913869] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:585; }","duration":"580.851223ms","start":"2026-04-14T07:48:02.802039Z","end":"2026-04-14T07:48:03.38289Z","steps":["trace[803913869] 'agreement among raft nodes before linearized reading' (duration: 580.799502ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.38359Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.801986Z","time spent":"581.592ms","remote":"127.0.0.1:50636","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:03.382974Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"482.363713ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.383632Z","caller":"traceutil/trace.go:171","msg":"trace[1911368039] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:585; }","duration":"483.041849ms","start":"2026-04-14T07:48:02.900575Z","end":"2026-04-14T07:48:03.383617Z","steps":["trace[1911368039] 'agreement among raft nodes before linearized reading' (duration: 482.379004ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383687Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.900544Z","time spent":"483.1324ms","remote":"127.0.0.1:50656","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:10000 "} {"level":"info","ts":"2026-04-14T07:48:03.382937Z","caller":"traceutil/trace.go:171","msg":"trace[613468708] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:585; }","duration":"580.762961ms","start":"2026-04-14T07:48:02.802158Z","end":"2026-04-14T07:48:03.382921Z","steps":["trace[613468708] 'agreement among raft nodes before linearized reading' (duration: 580.644179ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383768Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.802119Z","time spent":"581.640121ms","remote":"127.0.0.1:50636","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.382961Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"331.029121ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.383807Z","caller":"traceutil/trace.go:171","msg":"trace[252762942] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:585; }","duration":"331.988923ms","start":"2026-04-14T07:48:03.051806Z","end":"2026-04-14T07:48:03.383795Z","steps":["trace[252762942] 'agreement among raft nodes before linearized reading' (duration: 330.98311ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383005Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"425.99635ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:03.383881Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.051776Z","time spent":"332.089144ms","remote":"127.0.0.1:50684","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:10000 "} {"level":"info","ts":"2026-04-14T07:48:03.383888Z","caller":"traceutil/trace.go:171","msg":"trace[1653658963] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:585; }","duration":"426.89766ms","start":"2026-04-14T07:48:02.956983Z","end":"2026-04-14T07:48:03.383881Z","steps":["trace[1653658963] 'agreement among raft nodes before linearized reading' (duration: 426.00548ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383929Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.956972Z","time spent":"426.950812ms","remote":"127.0.0.1:50672","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.383038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"426.991093ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.384006Z","caller":"traceutil/trace.go:171","msg":"trace[1441320543] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:585; }","duration":"427.950204ms","start":"2026-04-14T07:48:02.956042Z","end":"2026-04-14T07:48:03.383992Z","steps":["trace[1441320543] 'agreement among raft nodes before linearized reading' (duration: 426.983343ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:03.383042Z","caller":"traceutil/trace.go:171","msg":"trace[1868309349] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:585; }","duration":"604.858848ms","start":"2026-04-14T07:48:02.778108Z","end":"2026-04-14T07:48:03.382967Z","steps":["trace[1868309349] 'agreement among raft nodes before linearized reading' (duration: 604.804777ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.384057Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.956007Z","time spent":"428.034446ms","remote":"127.0.0.1:50672","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:03.384092Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.778072Z","time spent":"606.009174ms","remote":"127.0.0.1:50634","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.383037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.908601ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.38414Z","caller":"traceutil/trace.go:171","msg":"trace[569353994] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:585; }","duration":"271.028085ms","start":"2026-04-14T07:48:03.113101Z","end":"2026-04-14T07:48:03.384129Z","steps":["trace[569353994] 'agreement among raft nodes before linearized reading' (duration: 269.9122ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383056Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"427.028874ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.384218Z","caller":"traceutil/trace.go:171","msg":"trace[440279445] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:585; }","duration":"428.18942ms","start":"2026-04-14T07:48:02.956024Z","end":"2026-04-14T07:48:03.384213Z","steps":["trace[440279445] 'agreement among raft nodes before linearized reading' (duration: 427.023944ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.384236Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.955989Z","time spent":"428.241292ms","remote":"127.0.0.1:50672","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.383058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"522.944876ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.384467Z","caller":"traceutil/trace.go:171","msg":"trace[215614898] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:585; }","duration":"524.330447ms","start":"2026-04-14T07:48:02.860099Z","end":"2026-04-14T07:48:03.384429Z","steps":["trace[215614898] 'agreement among raft nodes before linearized reading' (duration: 522.939306ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.384516Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.860095Z","time spent":"524.406509ms","remote":"127.0.0.1:50650","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.383077Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"450.996339ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.384651Z","caller":"traceutil/trace.go:171","msg":"trace[426263375] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:585; }","duration":"452.582594ms","start":"2026-04-14T07:48:02.932061Z","end":"2026-04-14T07:48:03.384644Z","steps":["trace[426263375] 'agreement among raft nodes before linearized reading' (duration: 451.004948ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.384692Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.932029Z","time spent":"452.653866ms","remote":"127.0.0.1:50658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.38308Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.792785ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.384797Z","caller":"traceutil/trace.go:171","msg":"trace[308822090] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:585; }","duration":"299.567714ms","start":"2026-04-14T07:48:03.085221Z","end":"2026-04-14T07:48:03.384789Z","steps":["trace[308822090] 'agreement among raft nodes before linearized reading' (duration: 297.840925ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383081Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"605.208757ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.385242Z","caller":"traceutil/trace.go:171","msg":"trace[145629524] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:585; }","duration":"607.384585ms","start":"2026-04-14T07:48:02.77785Z","end":"2026-04-14T07:48:03.385235Z","steps":["trace[145629524] 'agreement among raft nodes before linearized reading' (duration: 605.210236ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.385484Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.777844Z","time spent":"607.63052ms","remote":"127.0.0.1:50634","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:03.383097Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.722166ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.385636Z","caller":"traceutil/trace.go:171","msg":"trace[533901496] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:585; }","duration":"454.260034ms","start":"2026-04-14T07:48:02.93137Z","end":"2026-04-14T07:48:03.38563Z","steps":["trace[533901496] 'agreement among raft nodes before linearized reading' (duration: 451.715616ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.385699Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.9313Z","time spent":"454.390106ms","remote":"127.0.0.1:50658","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:03.383102Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.947548ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.385856Z","caller":"traceutil/trace.go:171","msg":"trace[773581194] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:585; }","duration":"300.711221ms","start":"2026-04-14T07:48:03.08514Z","end":"2026-04-14T07:48:03.385851Z","steps":["trace[773581194] 'agreement among raft nodes before linearized reading' (duration: 297.951338ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.385976Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.085132Z","time spent":"300.835773ms","remote":"127.0.0.1:50700","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:03.38282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"481.998525ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386134Z","caller":"traceutil/trace.go:171","msg":"trace[108985974] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:585; }","duration":"485.347011ms","start":"2026-04-14T07:48:02.900775Z","end":"2026-04-14T07:48:03.386122Z","steps":["trace[108985974] 'agreement among raft nodes before linearized reading' (duration: 482.001235ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.386176Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.900751Z","time spent":"485.411813ms","remote":"127.0.0.1:50656","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.383093Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"523.003487ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386243Z","caller":"traceutil/trace.go:171","msg":"trace[564088326] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:585; }","duration":"526.172619ms","start":"2026-04-14T07:48:02.860063Z","end":"2026-04-14T07:48:03.386236Z","steps":["trace[564088326] 'agreement among raft nodes before linearized reading' (duration: 523.011228ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.386267Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.860053Z","time spent":"526.20774ms","remote":"127.0.0.1:50650","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.383124Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.666112ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386321Z","caller":"traceutil/trace.go:171","msg":"trace[495769072] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:585; }","duration":"333.877235ms","start":"2026-04-14T07:48:03.052438Z","end":"2026-04-14T07:48:03.386315Z","steps":["trace[495769072] 'agreement among raft nodes before linearized reading' (duration: 330.673822ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.386356Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.052425Z","time spent":"333.922796ms","remote":"127.0.0.1:50684","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.383131Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"605.298259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386423Z","caller":"traceutil/trace.go:171","msg":"trace[59152601] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:585; }","duration":"608.615713ms","start":"2026-04-14T07:48:02.777797Z","end":"2026-04-14T07:48:03.386412Z","steps":["trace[59152601] 'agreement among raft nodes before linearized reading' (duration: 605.296418ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.38645Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.777769Z","time spent":"608.672795ms","remote":"127.0.0.1:50634","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.383144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"331.237425ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386555Z","caller":"traceutil/trace.go:171","msg":"trace[95906492] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:585; }","duration":"334.677823ms","start":"2026-04-14T07:48:03.051869Z","end":"2026-04-14T07:48:03.386547Z","steps":["trace[95906492] 'agreement among raft nodes before linearized reading' (duration: 331.262796ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.38658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.051844Z","time spent":"334.727055ms","remote":"127.0.0.1:50684","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:03.383142Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"580.546607ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386658Z","caller":"traceutil/trace.go:171","msg":"trace[690061370] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:585; }","duration":"584.086877ms","start":"2026-04-14T07:48:02.802562Z","end":"2026-04-14T07:48:03.386649Z","steps":["trace[690061370] 'agreement among raft nodes before linearized reading' (duration: 580.551436ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.386708Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.802554Z","time spent":"584.146888ms","remote":"127.0.0.1:50636","response type":"/etcdserverpb.KV/Range","request count":0,"request size":105,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:03.383173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"242.482816ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386806Z","caller":"traceutil/trace.go:171","msg":"trace[253820765] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:585; }","duration":"246.116278ms","start":"2026-04-14T07:48:03.140683Z","end":"2026-04-14T07:48:03.386799Z","steps":["trace[253820765] 'agreement among raft nodes before linearized reading' (duration: 242.477266ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383181Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.770024ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.386951Z","caller":"traceutil/trace.go:171","msg":"trace[274776243] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:585; }","duration":"130.57074ms","start":"2026-04-14T07:48:03.25637Z","end":"2026-04-14T07:48:03.386941Z","steps":["trace[274776243] 'agreement among raft nodes before linearized reading' (duration: 126.795555ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:03.383189Z","caller":"traceutil/trace.go:171","msg":"trace[1071840282] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"666.049361ms","start":"2026-04-14T07:48:02.717133Z","end":"2026-04-14T07:48:03.383182Z","steps":["trace[1071840282] 'process raft request' (duration: 665.206511ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.387109Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.717116Z","time spent":"669.959489ms","remote":"127.0.0.1:50176","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T07:48:03.383196Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.904756ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.387247Z","caller":"traceutil/trace.go:171","msg":"trace[1983977792] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:585; }","duration":"199.990809ms","start":"2026-04-14T07:48:03.187246Z","end":"2026-04-14T07:48:03.387237Z","steps":["trace[1983977792] 'agreement among raft nodes before linearized reading' (duration: 195.937967ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:03.38321Z","caller":"traceutil/trace.go:171","msg":"trace[950050525] transaction","detail":"{read_only:false; response_revision:584; number_of_response:1; }","duration":"725.34385ms","start":"2026-04-14T07:48:02.657861Z","end":"2026-04-14T07:48:03.383205Z","steps":["trace[950050525] 'process raft request' (duration: 724.352286ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.38743Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.657829Z","time spent":"729.549514ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:48:03.383222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.096511ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.387616Z","caller":"traceutil/trace.go:171","msg":"trace[2050748431] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:585; }","duration":"200.5036ms","start":"2026-04-14T07:48:03.187103Z","end":"2026-04-14T07:48:03.387606Z","steps":["trace[2050748431] 'agreement among raft nodes before linearized reading' (duration: 196.108591ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.735528ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.387729Z","caller":"traceutil/trace.go:171","msg":"trace[1028594400] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:585; }","duration":"129.286171ms","start":"2026-04-14T07:48:03.258428Z","end":"2026-04-14T07:48:03.387714Z","steps":["trace[1028594400] 'agreement among raft nodes before linearized reading' (duration: 124.766248ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.067129ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.388729Z","caller":"traceutil/trace.go:171","msg":"trace[1913101642] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:585; }","duration":"156.718545ms","start":"2026-04-14T07:48:03.231158Z","end":"2026-04-14T07:48:03.387876Z","steps":["trace[1913101642] 'agreement among raft nodes before linearized reading' (duration: 152.07821ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383263Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.809715ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.388898Z","caller":"traceutil/trace.go:171","msg":"trace[916439829] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:585; }","duration":"132.443793ms","start":"2026-04-14T07:48:03.256411Z","end":"2026-04-14T07:48:03.388854Z","steps":["trace[916439829] 'agreement among raft nodes before linearized reading' (duration: 126.832145ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.391631ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.389113Z","caller":"traceutil/trace.go:171","msg":"trace[1899866866] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:585; }","duration":"160.256425ms","start":"2026-04-14T07:48:03.228845Z","end":"2026-04-14T07:48:03.389102Z","steps":["trace[1899866866] 'agreement among raft nodes before linearized reading' (duration: 154.432812ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383377Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"243.842696ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.389274Z","caller":"traceutil/trace.go:171","msg":"trace[738218430] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:585; }","duration":"249.784111ms","start":"2026-04-14T07:48:03.139482Z","end":"2026-04-14T07:48:03.389266Z","steps":["trace[738218430] 'agreement among raft nodes before linearized reading' (duration: 243.873307ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383459Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"243.968529ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.389454Z","caller":"traceutil/trace.go:171","msg":"trace[1466775425] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:585; }","duration":"249.981856ms","start":"2026-04-14T07:48:03.139462Z","end":"2026-04-14T07:48:03.389444Z","steps":["trace[1466775425] 'agreement among raft nodes before linearized reading' (duration: 243.96834ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.383012Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"522.886014ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:03.389647Z","caller":"traceutil/trace.go:171","msg":"trace[1560147394] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:585; }","duration":"529.526055ms","start":"2026-04-14T07:48:02.860112Z","end":"2026-04-14T07:48:03.389638Z","steps":["trace[1560147394] 'agreement among raft nodes before linearized reading' (duration: 522.879744ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:03.389695Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:02.860109Z","time spent":"529.572217ms","remote":"127.0.0.1:50650","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:04.670501Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"954.499232ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-04-14T07:48:04.670612Z","caller":"traceutil/trace.go:171","msg":"trace[716415690] transaction","detail":"{read_only:false; response_revision:590; number_of_response:1; }","duration":"1.149038997s","start":"2026-04-14T07:48:03.521555Z","end":"2026-04-14T07:48:04.670594Z","steps":["trace[716415690] 'process raft request' (duration: 194.370761ms)","trace[716415690] 'compare' (duration: 954.37901ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:48:04.670669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.521537Z","time spent":"1.149110258s","remote":"127.0.0.1:50020","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":905,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T07:48:05.364635Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.648708573s","expected-duration":"1s"} {"level":"info","ts":"2026-04-14T07:48:05.365779Z","caller":"traceutil/trace.go:171","msg":"trace[417156886] transaction","detail":"{read_only:false; response_revision:591; number_of_response:1; }","duration":"1.842959282s","start":"2026-04-14T07:48:03.522793Z","end":"2026-04-14T07:48:05.365753Z","steps":["trace[417156886] 'process raft request' (duration: 1.84201751s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.365908Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.522775Z","time spent":"1.843074334s","remote":"127.0.0.1:50020","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":775,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T07:48:05.365899Z","caller":"traceutil/trace.go:171","msg":"trace[341566055] transaction","detail":"{read_only:false; response_revision:592; number_of_response:1; }","duration":"1.842438089s","start":"2026-04-14T07:48:03.523436Z","end":"2026-04-14T07:48:05.365875Z","steps":["trace[341566055] 'process raft request' (duration: 1.842247235s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.523431Z","time spent":"1.842551442s","remote":"127.0.0.1:50176","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:48:05.366179Z","caller":"traceutil/trace.go:171","msg":"trace[1691294236] linearizableReadLoop","detail":"{readStateIndex:612; appliedIndex:608; }","duration":"1.726524964s","start":"2026-04-14T07:48:03.639642Z","end":"2026-04-14T07:48:05.366167Z","steps":["trace[1691294236] 'read index received' (duration: 76.270215ms)","trace[1691294236] 'applied index is now lower than readState.Index' (duration: 1.650252739s)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:48:05.366403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.726718898s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:05.366404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.726731268s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.366446Z","caller":"traceutil/trace.go:171","msg":"trace[676271397] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:593; }","duration":"1.726774149s","start":"2026-04-14T07:48:03.639664Z","end":"2026-04-14T07:48:05.366438Z","steps":["trace[676271397] 'agreement among raft nodes before linearized reading' (duration: 1.726706257s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366469Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.639661Z","time spent":"1.726801219s","remote":"127.0.0.1:50826","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:05.366459Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.551663976s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.366457Z","caller":"traceutil/trace.go:171","msg":"trace[536747174] transaction","detail":"{read_only:false; response_revision:593; number_of_response:1; }","duration":"1.842681496s","start":"2026-04-14T07:48:03.523751Z","end":"2026-04-14T07:48:05.366433Z","steps":["trace[536747174] 'process raft request' (duration: 1.842070101s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:05.366475Z","caller":"traceutil/trace.go:171","msg":"trace[1721111363] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:593; }","duration":"1.72683647s","start":"2026-04-14T07:48:03.639622Z","end":"2026-04-14T07:48:05.366458Z","steps":["trace[1721111363] 'agreement among raft nodes before linearized reading' (duration: 1.726705787s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:05.366507Z","caller":"traceutil/trace.go:171","msg":"trace[1872939566] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:593; }","duration":"1.551729657s","start":"2026-04-14T07:48:03.814757Z","end":"2026-04-14T07:48:05.366487Z","steps":["trace[1872939566] 'agreement among raft nodes before linearized reading' (duration: 1.551664876s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366525Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.639611Z","time spent":"1.726903752s","remote":"127.0.0.1:50826","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:05.366542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.81475Z","time spent":"1.551782908s","remote":"127.0.0.1:50850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":108,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:05.366576Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.523745Z","time spent":"1.842757507s","remote":"127.0.0.1:50148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3209,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:48:05.36661Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.551866851s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.366638Z","caller":"traceutil/trace.go:171","msg":"trace[837175159] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:593; }","duration":"1.551912321s","start":"2026-04-14T07:48:03.814717Z","end":"2026-04-14T07:48:05.366629Z","steps":["trace[837175159] 'agreement among raft nodes before linearized reading' (duration: 1.55186237s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.814709Z","time spent":"1.551943362s","remote":"127.0.0.1:50850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:05.366651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"715.542107ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:05.366729Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.530367642s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:05.36676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.55228458s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.36675Z","caller":"traceutil/trace.go:171","msg":"trace[1250983397] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:593; }","duration":"715.653989ms","start":"2026-04-14T07:48:04.651071Z","end":"2026-04-14T07:48:05.366725Z","steps":["trace[1250983397] 'agreement among raft nodes before linearized reading' (duration: 715.501436ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:05.366779Z","caller":"traceutil/trace.go:171","msg":"trace[331687654] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:593; }","duration":"1.55233857s","start":"2026-04-14T07:48:03.814434Z","end":"2026-04-14T07:48:05.366773Z","steps":["trace[331687654] 'agreement among raft nodes before linearized reading' (duration: 1.55230905s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366798Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.814412Z","time spent":"1.552381212s","remote":"127.0.0.1:50846","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:05.366802Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:04.651019Z","time spent":"715.774322ms","remote":"127.0.0.1:49962","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-04-14T07:48:05.366812Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.532040239s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:05.36683Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.597015447s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.36685Z","caller":"traceutil/trace.go:171","msg":"trace[728002659] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:593; }","duration":"1.53207355s","start":"2026-04-14T07:48:03.834763Z","end":"2026-04-14T07:48:05.366837Z","steps":["trace[728002659] 'agreement among raft nodes before linearized reading' (duration: 1.532016539s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:05.366868Z","caller":"traceutil/trace.go:171","msg":"trace[986242359] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:593; }","duration":"1.597066698s","start":"2026-04-14T07:48:03.769792Z","end":"2026-04-14T07:48:05.366859Z","steps":["trace[986242359] 'agreement among raft nodes before linearized reading' (duration: 1.597009087s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.366879Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.834753Z","time spent":"1.532118491s","remote":"127.0.0.1:50866","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:05.3669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.769786Z","time spent":"1.597105819s","remote":"127.0.0.1:50826","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:05.366949Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.597362845s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.36699Z","caller":"traceutil/trace.go:171","msg":"trace[2018051907] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:593; }","duration":"1.597427916s","start":"2026-04-14T07:48:03.76955Z","end":"2026-04-14T07:48:05.366978Z","steps":["trace[2018051907] 'agreement among raft nodes before linearized reading' (duration: 1.597356784s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.367033Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.769532Z","time spent":"1.597492688s","remote":"127.0.0.1:50832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:05.367044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.532306575s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.366762Z","caller":"traceutil/trace.go:171","msg":"trace[1956173225] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:593; }","duration":"1.530431543s","start":"2026-04-14T07:48:03.83632Z","end":"2026-04-14T07:48:05.366751Z","steps":["trace[1956173225] 'agreement among raft nodes before linearized reading' (duration: 1.530372102s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:05.367084Z","caller":"traceutil/trace.go:171","msg":"trace[1261582250] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:593; }","duration":"1.532379857s","start":"2026-04-14T07:48:03.834693Z","end":"2026-04-14T07:48:05.367073Z","steps":["trace[1261582250] 'agreement among raft nodes before linearized reading' (duration: 1.532316426s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.367115Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.834675Z","time spent":"1.532431628s","remote":"127.0.0.1:50866","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:05.367116Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.836308Z","time spent":"1.530789362s","remote":"127.0.0.1:50866","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:500 "} {"level":"warn","ts":"2026-04-14T07:48:05.367286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.597316384s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.367313Z","caller":"traceutil/trace.go:171","msg":"trace[1331923997] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:593; }","duration":"1.597375195s","start":"2026-04-14T07:48:03.769929Z","end":"2026-04-14T07:48:05.367304Z","steps":["trace[1331923997] 'agreement among raft nodes before linearized reading' (duration: 1.597333654s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.367323Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.572259833s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:05.367333Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.769907Z","time spent":"1.597421366s","remote":"127.0.0.1:50832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"info","ts":"2026-04-14T07:48:05.367356Z","caller":"traceutil/trace.go:171","msg":"trace[1209914932] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:593; }","duration":"1.572295274s","start":"2026-04-14T07:48:03.795052Z","end":"2026-04-14T07:48:05.367348Z","steps":["trace[1209914932] 'agreement among raft nodes before linearized reading' (duration: 1.572243623s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.367568Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.795046Z","time spent":"1.572332465s","remote":"127.0.0.1:50846","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T07:48:05.369795Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.574423334s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:05.369859Z","caller":"traceutil/trace.go:171","msg":"trace[816108980] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:593; }","duration":"1.574551056s","start":"2026-04-14T07:48:03.795288Z","end":"2026-04-14T07:48:05.369839Z","steps":["trace[816108980] 'agreement among raft nodes before linearized reading' (duration: 1.571718272s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:05.369904Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:03.795266Z","time spent":"1.574623977s","remote":"127.0.0.1:50846","response type":"/etcdserverpb.KV/Range","request count":0,"request size":108,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:48:07.172433Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.517255ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodeconfigs.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:48:07.172533Z","caller":"traceutil/trace.go:171","msg":"trace[1004595612] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodeconfigs.cilium.io; range_end:; response_count:0; response_revision:627; }","duration":"300.634768ms","start":"2026-04-14T07:48:06.871877Z","end":"2026-04-14T07:48:07.172512Z","steps":["trace[1004595612] 'range keys from in-memory index tree' (duration: 300.327481ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:07.172575Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:06.871776Z","time spent":"300.788632ms","remote":"127.0.0.1:50004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":86,"response count":0,"response size":29,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodeconfigs.cilium.io\" "} {"level":"info","ts":"2026-04-14T07:48:07.178184Z","caller":"traceutil/trace.go:171","msg":"trace[669073401] transaction","detail":"{read_only:false; response_revision:628; number_of_response:1; }","duration":"104.352783ms","start":"2026-04-14T07:48:07.073805Z","end":"2026-04-14T07:48:07.178158Z","steps":["trace[669073401] 'process raft request' (duration: 104.162309ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:20.012983Z","caller":"traceutil/trace.go:171","msg":"trace[1262435842] transaction","detail":"{read_only:false; response_revision:748; number_of_response:1; }","duration":"284.800879ms","start":"2026-04-14T07:48:19.72814Z","end":"2026-04-14T07:48:20.012941Z","steps":["trace[1262435842] 'process raft request' (duration: 284.483232ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:55.809098Z","caller":"traceutil/trace.go:171","msg":"trace[1564627561] linearizableReadLoop","detail":"{readStateIndex:1003; appliedIndex:1002; }","duration":"159.197781ms","start":"2026-04-14T07:48:55.649877Z","end":"2026-04-14T07:48:55.809075Z","steps":["trace[1564627561] 'read index received' (duration: 158.966206ms)","trace[1564627561] 'applied index is now lower than readState.Index' (duration: 230.645µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:48:55.809145Z","caller":"traceutil/trace.go:171","msg":"trace[89662405] transaction","detail":"{read_only:false; response_revision:970; number_of_response:1; }","duration":"163.489999ms","start":"2026-04-14T07:48:55.645625Z","end":"2026-04-14T07:48:55.809115Z","steps":["trace[89662405] 'process raft request' (duration: 163.303985ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:55.809283Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.383195ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T07:48:55.80932Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.761645ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T07:48:55.809334Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.59603ms","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-04-14T07:48:55.809375Z","caller":"traceutil/trace.go:171","msg":"trace[378892882] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:970; }","duration":"134.861868ms","start":"2026-04-14T07:48:55.674502Z","end":"2026-04-14T07:48:55.809364Z","steps":["trace[378892882] 'agreement among raft nodes before linearized reading' (duration: 134.706154ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:55.809393Z","caller":"traceutil/trace.go:171","msg":"trace[270246225] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:970; }","duration":"126.698772ms","start":"2026-04-14T07:48:55.682681Z","end":"2026-04-14T07:48:55.80938Z","steps":["trace[270246225] 'agreement among raft nodes before linearized reading' (duration: 126.559599ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:55.809485Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.679113ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:48:55.809511Z","caller":"traceutil/trace.go:171","msg":"trace[637315205] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:970; }","duration":"130.743165ms","start":"2026-04-14T07:48:55.67876Z","end":"2026-04-14T07:48:55.809503Z","steps":["trace[637315205] 'agreement among raft nodes before linearized reading' (duration: 130.628252ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:55.809348Z","caller":"traceutil/trace.go:171","msg":"trace[111851184] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:970; }","duration":"159.496608ms","start":"2026-04-14T07:48:55.649836Z","end":"2026-04-14T07:48:55.809333Z","steps":["trace[111851184] 'agreement among raft nodes before linearized reading' (duration: 159.358775ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:48:56.41512Z","caller":"traceutil/trace.go:171","msg":"trace[140713392] transaction","detail":"{read_only:false; response_revision:972; number_of_response:1; }","duration":"601.459371ms","start":"2026-04-14T07:48:55.813643Z","end":"2026-04-14T07:48:56.415103Z","steps":["trace[140713392] 'process raft request' (duration: 601.322088ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:56.415239Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:55.813626Z","time spent":"601.550022ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:48:56.415293Z","caller":"traceutil/trace.go:171","msg":"trace[562114702] transaction","detail":"{read_only:false; response_revision:973; number_of_response:1; }","duration":"601.526291ms","start":"2026-04-14T07:48:55.813738Z","end":"2026-04-14T07:48:56.415265Z","steps":["trace[562114702] 'process raft request' (duration: 601.325667ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:48:56.415437Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:48:55.813731Z","time spent":"601.623464ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:12.12386Z","caller":"traceutil/trace.go:171","msg":"trace[1906778713] linearizableReadLoop","detail":"{readStateIndex:1059; appliedIndex:1058; }","duration":"230.687008ms","start":"2026-04-14T07:49:11.89315Z","end":"2026-04-14T07:49:12.123837Z","steps":["trace[1906778713] 'read index received' (duration: 230.443223ms)","trace[1906778713] 'applied index is now lower than readState.Index' (duration: 240.345µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:12.123941Z","caller":"traceutil/trace.go:171","msg":"trace[748954593] transaction","detail":"{read_only:false; response_revision:1023; number_of_response:1; }","duration":"233.066592ms","start":"2026-04-14T07:49:11.890844Z","end":"2026-04-14T07:49:12.12391Z","steps":["trace[748954593] 'process raft request' (duration: 232.840637ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:12.124102Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.919403ms","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-04-14T07:49:12.124172Z","caller":"traceutil/trace.go:171","msg":"trace[1033662971] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1023; }","duration":"231.052596ms","start":"2026-04-14T07:49:11.893101Z","end":"2026-04-14T07:49:12.124154Z","steps":["trace[1033662971] 'agreement among raft nodes before linearized reading' (duration: 230.832341ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:12.299757Z","caller":"traceutil/trace.go:171","msg":"trace[1316002657] linearizableReadLoop","detail":"{readStateIndex:1060; appliedIndex:1059; }","duration":"134.07748ms","start":"2026-04-14T07:49:12.165651Z","end":"2026-04-14T07:49:12.299728Z","steps":["trace[1316002657] 'read index received' (duration: 97.687263ms)","trace[1316002657] 'applied index is now lower than readState.Index' (duration: 36.388917ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:12.299778Z","caller":"traceutil/trace.go:171","msg":"trace[1043993429] transaction","detail":"{read_only:false; response_revision:1024; number_of_response:1; }","duration":"171.40491ms","start":"2026-04-14T07:49:12.128343Z","end":"2026-04-14T07:49:12.299748Z","steps":["trace[1043993429] 'process raft request' (duration: 135.029232ms)","trace[1043993429] 'compare' (duration: 36.210604ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:12.299879Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.211203ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:12.29991Z","caller":"traceutil/trace.go:171","msg":"trace[731825966] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:1024; }","duration":"134.256614ms","start":"2026-04-14T07:49:12.165645Z","end":"2026-04-14T07:49:12.299901Z","steps":["trace[731825966] 'agreement among raft nodes before linearized reading' (duration: 134.181773ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:17.441473Z","caller":"traceutil/trace.go:171","msg":"trace[1509193601] linearizableReadLoop","detail":"{readStateIndex:1077; appliedIndex:1076; }","duration":"426.84716ms","start":"2026-04-14T07:49:17.014605Z","end":"2026-04-14T07:49:17.441452Z","steps":["trace[1509193601] 'read index received' (duration: 426.638155ms)","trace[1509193601] 'applied index is now lower than readState.Index' (duration: 208.145µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:17.441748Z","caller":"traceutil/trace.go:171","msg":"trace[978668852] transaction","detail":"{read_only:false; response_revision:1040; number_of_response:1; }","duration":"462.069791ms","start":"2026-04-14T07:49:16.979666Z","end":"2026-04-14T07:49:17.441736Z","steps":["trace[978668852] 'process raft request' (duration: 461.638151ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:17.441854Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:16.979641Z","time spent":"462.141632ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:17.442052Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"427.446733ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-14T07:49:17.442088Z","caller":"traceutil/trace.go:171","msg":"trace[476556551] range","detail":"{range_begin:/registry/apiregistration.k8s.io/apiservices/; range_end:/registry/apiregistration.k8s.io/apiservices0; response_count:0; response_revision:1040; }","duration":"427.510364ms","start":"2026-04-14T07:49:17.014566Z","end":"2026-04-14T07:49:17.442077Z","steps":["trace[476556551] 'agreement among raft nodes before linearized reading' (duration: 427.437952ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:17.442118Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:17.014546Z","time spent":"427.563825ms","remote":"127.0.0.1:50456","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":29,"response size":31,"request content":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:49:17.442403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"343.82807ms","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-04-14T07:49:17.442479Z","caller":"traceutil/trace.go:171","msg":"trace[283282705] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1040; }","duration":"343.958623ms","start":"2026-04-14T07:49:17.098503Z","end":"2026-04-14T07:49:17.442461Z","steps":["trace[283282705] 'agreement among raft nodes before linearized reading' (duration: 343.747579ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:17.442508Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.775928ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-04-14T07:49:17.442526Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:17.098481Z","time spent":"344.036154ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-04-14T07:49:17.44255Z","caller":"traceutil/trace.go:171","msg":"trace[647444727] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1040; }","duration":"237.840389ms","start":"2026-04-14T07:49:17.2047Z","end":"2026-04-14T07:49:17.442541Z","steps":["trace[647444727] 'agreement among raft nodes before linearized reading' (duration: 237.738687ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:17.442748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"325.352861ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.30\" ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-04-14T07:49:17.442817Z","caller":"traceutil/trace.go:171","msg":"trace[321642736] range","detail":"{range_begin:/registry/masterleases/199.204.45.30; range_end:; response_count:1; response_revision:1040; }","duration":"325.391982ms","start":"2026-04-14T07:49:17.117386Z","end":"2026-04-14T07:49:17.442778Z","steps":["trace[321642736] 'agreement among raft nodes before linearized reading' (duration: 325.29938ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:17.442851Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:17.117328Z","time spent":"325.515485ms","remote":"127.0.0.1:49984","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.30\" "} {"level":"warn","ts":"2026-04-14T07:49:18.166433Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"501.800844ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:41"} {"level":"warn","ts":"2026-04-14T07:49:18.166517Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:17.443448Z","time spent":"723.066088ms","remote":"127.0.0.1:49984","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-04-14T07:49:18.203501Z","caller":"traceutil/trace.go:171","msg":"trace[556815385] transaction","detail":"{read_only:false; response_revision:1041; number_of_response:1; }","duration":"757.454989ms","start":"2026-04-14T07:49:17.446026Z","end":"2026-04-14T07:49:18.203481Z","steps":["trace[556815385] 'process raft request' (duration: 757.347257ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:18.20361Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:17.44601Z","time spent":"757.541922ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:18.217756Z","caller":"traceutil/trace.go:171","msg":"trace[1762333210] transaction","detail":"{read_only:false; response_revision:1042; number_of_response:1; }","duration":"275.522517ms","start":"2026-04-14T07:49:17.942201Z","end":"2026-04-14T07:49:18.217724Z","steps":["trace[1762333210] 'process raft request' (duration: 275.295261ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:19.697432Z","caller":"traceutil/trace.go:171","msg":"trace[13739545] transaction","detail":"{read_only:false; response_revision:1048; number_of_response:1; }","duration":"249.771051ms","start":"2026-04-14T07:49:19.447628Z","end":"2026-04-14T07:49:19.697399Z","steps":["trace[13739545] 'process raft request' (duration: 249.513425ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.798105Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980081348,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-14T07:49:20.919743Z","caller":"traceutil/trace.go:171","msg":"trace[637846957] linearizableReadLoop","detail":"{readStateIndex:1087; appliedIndex:1086; }","duration":"621.675181ms","start":"2026-04-14T07:49:20.298043Z","end":"2026-04-14T07:49:20.919718Z","steps":["trace[637846957] 'read index received' (duration: 621.447306ms)","trace[637846957] 'applied index is now lower than readState.Index' (duration: 226.945µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:20.919861Z","caller":"traceutil/trace.go:171","msg":"trace[1150468185] transaction","detail":"{read_only:false; response_revision:1049; number_of_response:1; }","duration":"708.296302ms","start":"2026-04-14T07:49:20.211554Z","end":"2026-04-14T07:49:20.91985Z","steps":["trace[1150468185] 'process raft request' (duration: 708.026046ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.92007Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"567.768865ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T07:49:20.920256Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.902649ms","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-04-14T07:49:20.92028Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.557406ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:49:20.92033Z","caller":"traceutil/trace.go:171","msg":"trace[826961010] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1049; }","duration":"270.023822ms","start":"2026-04-14T07:49:20.650288Z","end":"2026-04-14T07:49:20.920312Z","steps":["trace[826961010] 'agreement among raft nodes before linearized reading' (duration: 269.833488ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:20.920342Z","caller":"traceutil/trace.go:171","msg":"trace[1926704822] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1049; }","duration":"183.651878ms","start":"2026-04-14T07:49:20.736672Z","end":"2026-04-14T07:49:20.920324Z","steps":["trace[1926704822] 'agreement among raft nodes before linearized reading' (duration: 183.426823ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.92021Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"473.574932ms","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-04-14T07:49:20.920434Z","caller":"traceutil/trace.go:171","msg":"trace[233259401] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:1049; }","duration":"473.844289ms","start":"2026-04-14T07:49:20.446579Z","end":"2026-04-14T07:49:20.920423Z","steps":["trace[233259401] 'agreement among raft nodes before linearized reading' (duration: 473.585633ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.920505Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.446523Z","time spent":"473.966441ms","remote":"127.0.0.1:50148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":11,"response size":31,"request content":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:49:20.92031Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"622.245054ms","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-04-14T07:49:20.920642Z","caller":"traceutil/trace.go:171","msg":"trace[727061702] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1049; }","duration":"622.637643ms","start":"2026-04-14T07:49:20.297983Z","end":"2026-04-14T07:49:20.920621Z","steps":["trace[727061702] 'agreement among raft nodes before linearized reading' (duration: 622.114121ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.920704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.297956Z","time spent":"622.734405ms","remote":"127.0.0.1:50200","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-04-14T07:49:20.920847Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.211537Z","time spent":"709.219182ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:20.920292Z","caller":"traceutil/trace.go:171","msg":"trace[1312222907] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1049; }","duration":"568.062172ms","start":"2026-04-14T07:49:20.352216Z","end":"2026-04-14T07:49:20.920278Z","steps":["trace[1312222907] 'agreement among raft nodes before linearized reading' (duration: 567.719565ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:20.921214Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.352183Z","time spent":"568.986882ms","remote":"127.0.0.1:50200","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":"warn","ts":"2026-04-14T07:49:21.460714Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980081351,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-14T07:49:22.858816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.058690762s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T07:49:22.858893Z","caller":"traceutil/trace.go:171","msg":"trace[490135791] transaction","detail":"{read_only:false; response_revision:1050; number_of_response:1; }","duration":"1.934396023s","start":"2026-04-14T07:49:20.924481Z","end":"2026-04-14T07:49:22.858877Z","steps":["trace[490135791] 'process raft request' (duration: 875.575538ms)","trace[490135791] 'compare' (duration: 1.058057738s)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:22.858933Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.924456Z","time spent":"1.934457924s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:22.950044Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.140643726s","expected-duration":"1s"} {"level":"info","ts":"2026-04-14T07:49:22.951014Z","caller":"traceutil/trace.go:171","msg":"trace[878696037] transaction","detail":"{read_only:false; response_revision:1051; number_of_response:1; }","duration":"2.02575385s","start":"2026-04-14T07:49:20.925224Z","end":"2026-04-14T07:49:22.950978Z","steps":["trace[878696037] 'process raft request' (duration: 2.025250209s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:22.951096Z","caller":"traceutil/trace.go:171","msg":"trace[1363783232] transaction","detail":"{read_only:false; response_revision:1053; number_of_response:1; }","duration":"2.024300447s","start":"2026-04-14T07:49:20.926778Z","end":"2026-04-14T07:49:22.951079Z","steps":["trace[1363783232] 'process raft request' (duration: 2.024190965s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:22.951204Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.925199Z","time spent":"2.025906023s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:22.951254Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.926773Z","time spent":"2.024401569s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:22.951365Z","caller":"traceutil/trace.go:171","msg":"trace[67502383] linearizableReadLoop","detail":"{readStateIndex:1091; appliedIndex:1087; }","duration":"1.991027411s","start":"2026-04-14T07:49:20.96029Z","end":"2026-04-14T07:49:22.951317Z","steps":["trace[67502383] 'read index received' (duration: 839.778663ms)","trace[67502383] 'applied index is now lower than readState.Index' (duration: 1.151247968s)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:22.951442Z","caller":"traceutil/trace.go:171","msg":"trace[2008433877] transaction","detail":"{read_only:false; response_revision:1052; number_of_response:1; }","duration":"2.024701987s","start":"2026-04-14T07:49:20.926706Z","end":"2026-04-14T07:49:22.951408Z","steps":["trace[2008433877] 'process raft request' (duration: 2.024125404s)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:22.951499Z","caller":"traceutil/trace.go:171","msg":"trace[234784064] transaction","detail":"{read_only:false; response_revision:1054; number_of_response:1; }","duration":"1.249019752s","start":"2026-04-14T07:49:21.702471Z","end":"2026-04-14T07:49:22.95149Z","steps":["trace[234784064] 'process raft request' (duration: 1.248542501s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:22.95158Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.991302156s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-04-14T07:49:22.951583Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.926698Z","time spent":"2.024799479s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:22.951629Z","caller":"traceutil/trace.go:171","msg":"trace[245928927] range","detail":"{range_begin:/registry/priorityclasses/; range_end:/registry/priorityclasses0; response_count:0; response_revision:1054; }","duration":"1.991420779s","start":"2026-04-14T07:49:20.960199Z","end":"2026-04-14T07:49:22.95162Z","steps":["trace[245928927] 'agreement among raft nodes before linearized reading' (duration: 1.991348608s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:22.95162Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:21.702445Z","time spent":"1.249110494s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:22.951662Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:20.960163Z","time spent":"1.99148967s","remote":"127.0.0.1:50306","response type":"/etcdserverpb.KV/Range","request count":0,"request size":58,"response count":2,"response size":31,"request content":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:49:23.033102Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.382067507s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:23.033187Z","caller":"traceutil/trace.go:171","msg":"trace[256742078] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1054; }","duration":"1.382225251s","start":"2026-04-14T07:49:21.650944Z","end":"2026-04-14T07:49:23.033169Z","steps":["trace[256742078] 'agreement among raft nodes before linearized reading' (duration: 1.382066658s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:23.03323Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:21.650922Z","time spent":"1.382299372s","remote":"127.0.0.1:49962","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-04-14T07:49:23.033228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"678.106285ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-04-14T07:49:23.033228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.196275402s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:23.033313Z","caller":"traceutil/trace.go:171","msg":"trace[562907368] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:1054; }","duration":"678.250248ms","start":"2026-04-14T07:49:22.355043Z","end":"2026-04-14T07:49:23.033294Z","steps":["trace[562907368] 'agreement among raft nodes before linearized reading' (duration: 678.077114ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:23.033366Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:22.355009Z","time spent":"678.346189ms","remote":"127.0.0.1:50188","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":1,"response size":31,"request content":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true "} {"level":"info","ts":"2026-04-14T07:49:23.033328Z","caller":"traceutil/trace.go:171","msg":"trace[760031546] range","detail":"{range_begin:/registry/csidrivers/; range_end:/registry/csidrivers0; response_count:0; response_revision:1054; }","duration":"1.196462215s","start":"2026-04-14T07:49:21.836852Z","end":"2026-04-14T07:49:23.033314Z","steps":["trace[760031546] 'agreement among raft nodes before linearized reading' (duration: 1.196319342s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:23.033398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.955715ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"warn","ts":"2026-04-14T07:49:23.033498Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:21.836825Z","time spent":"1.196621739s","remote":"127.0.0.1:50338","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":0,"response size":29,"request content":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" count_only:true "} {"level":"info","ts":"2026-04-14T07:49:23.033544Z","caller":"traceutil/trace.go:171","msg":"trace[905334265] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1054; }","duration":"108.264472ms","start":"2026-04-14T07:49:22.925237Z","end":"2026-04-14T07:49:23.033502Z","steps":["trace[905334265] 'agreement among raft nodes before linearized reading' (duration: 107.817912ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:25.28294Z","caller":"traceutil/trace.go:171","msg":"trace[1533532338] linearizableReadLoop","detail":"{readStateIndex:1096; appliedIndex:1095; }","duration":"327.419038ms","start":"2026-04-14T07:49:24.955492Z","end":"2026-04-14T07:49:25.282911Z","steps":["trace[1533532338] 'read index received' (duration: 327.335596ms)","trace[1533532338] 'applied index is now lower than readState.Index' (duration: 82.192µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:25.28308Z","caller":"traceutil/trace.go:171","msg":"trace[2001433015] transaction","detail":"{read_only:false; response_revision:1057; number_of_response:1; }","duration":"417.372964ms","start":"2026-04-14T07:49:24.86567Z","end":"2026-04-14T07:49:25.283043Z","steps":["trace[2001433015] 'process raft request' (duration: 417.079967ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:25.283251Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"327.734175ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T07:49:25.283347Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:24.865655Z","time spent":"417.595349ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:25.283391Z","caller":"traceutil/trace.go:171","msg":"trace[1090972038] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1057; }","duration":"327.865458ms","start":"2026-04-14T07:49:24.955453Z","end":"2026-04-14T07:49:25.283318Z","steps":["trace[1090972038] 'agreement among raft nodes before linearized reading' (duration: 327.588342ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:25.283476Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:24.955431Z","time spent":"328.029812ms","remote":"127.0.0.1:50200","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-04-14T07:49:25.585462Z","caller":"traceutil/trace.go:171","msg":"trace[40320773] linearizableReadLoop","detail":"{readStateIndex:1097; appliedIndex:1096; }","duration":"302.423099ms","start":"2026-04-14T07:49:25.28301Z","end":"2026-04-14T07:49:25.585434Z","steps":["trace[40320773] 'read index received' (duration: 283.96955ms)","trace[40320773] 'applied index is now lower than readState.Index' (duration: 18.451909ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:25.585538Z","caller":"traceutil/trace.go:171","msg":"trace[314726846] transaction","detail":"{read_only:false; response_revision:1058; number_of_response:1; }","duration":"628.406804ms","start":"2026-04-14T07:49:24.957109Z","end":"2026-04-14T07:49:25.585515Z","steps":["trace[314726846] 'process raft request' (duration: 609.717309ms)","trace[314726846] 'compare' (duration: 18.282046ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:25.585701Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:24.957091Z","time spent":"628.490655ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:25.585717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"481.866181ms","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":"warn","ts":"2026-04-14T07:49:25.585716Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"630.135534ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:49:25.585802Z","caller":"traceutil/trace.go:171","msg":"trace[1323200289] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1058; }","duration":"481.981704ms","start":"2026-04-14T07:49:25.103794Z","end":"2026-04-14T07:49:25.585776Z","steps":["trace[1323200289] 'agreement among raft nodes before linearized reading' (duration: 481.725518ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:25.585816Z","caller":"traceutil/trace.go:171","msg":"trace[56270174] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1058; }","duration":"630.245606ms","start":"2026-04-14T07:49:24.955547Z","end":"2026-04-14T07:49:25.585792Z","steps":["trace[56270174] 'agreement among raft nodes before linearized reading' (duration: 629.99238ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:25.585884Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:24.95554Z","time spent":"630.326448ms","remote":"127.0.0.1:50200","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-04-14T07:49:25.585884Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:25.103775Z","time spent":"482.086096ms","remote":"127.0.0.1:50200","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-04-14T07:49:25.586171Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"630.455851ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:49:25.586259Z","caller":"traceutil/trace.go:171","msg":"trace[1577159979] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1058; }","duration":"630.596944ms","start":"2026-04-14T07:49:24.955643Z","end":"2026-04-14T07:49:25.586239Z","steps":["trace[1577159979] 'agreement among raft nodes before linearized reading' (duration: 630.329538ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:25.586343Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:24.955619Z","time spent":"630.711617ms","remote":"127.0.0.1:50200","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":"info","ts":"2026-04-14T07:49:25.600312Z","caller":"traceutil/trace.go:171","msg":"trace[1333417103] transaction","detail":"{read_only:false; response_revision:1059; number_of_response:1; }","duration":"312.395507ms","start":"2026-04-14T07:49:25.287895Z","end":"2026-04-14T07:49:25.60029Z","steps":["trace[1333417103] 'process raft request' (duration: 312.287443ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:25.600451Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:25.287863Z","time spent":"312.51668ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:35.800667Z","caller":"traceutil/trace.go:171","msg":"trace[152408340] linearizableReadLoop","detail":"{readStateIndex:1186; appliedIndex:1185; }","duration":"132.849202ms","start":"2026-04-14T07:49:35.667791Z","end":"2026-04-14T07:49:35.80064Z","steps":["trace[152408340] 'read index received' (duration: 125.966895ms)","trace[152408340] 'applied index is now lower than readState.Index' (duration: 6.877377ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:35.801121Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.295663ms","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-04-14T07:49:35.801242Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.216607ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:49:35.801275Z","caller":"traceutil/trace.go:171","msg":"trace[1263751290] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1143; }","duration":"133.478306ms","start":"2026-04-14T07:49:35.667764Z","end":"2026-04-14T07:49:35.801242Z","steps":["trace[1263751290] 'agreement among raft nodes before linearized reading' (duration: 133.070367ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:35.801296Z","caller":"traceutil/trace.go:171","msg":"trace[1420253583] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1143; }","duration":"132.426712ms","start":"2026-04-14T07:49:35.668852Z","end":"2026-04-14T07:49:35.801279Z","steps":["trace[1420253583] 'agreement among raft nodes before linearized reading' (duration: 132.168877ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:35.801536Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.441396ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T07:49:35.801563Z","caller":"traceutil/trace.go:171","msg":"trace[491464852] transaction","detail":"{read_only:false; response_revision:1143; number_of_response:1; }","duration":"136.576837ms","start":"2026-04-14T07:49:35.664969Z","end":"2026-04-14T07:49:35.801546Z","steps":["trace[491464852] 'process raft request' (duration: 128.77366ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:35.801569Z","caller":"traceutil/trace.go:171","msg":"trace[1472585678] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1143; }","duration":"126.474687ms","start":"2026-04-14T07:49:35.675084Z","end":"2026-04-14T07:49:35.801559Z","steps":["trace[1472585678] 'agreement among raft nodes before linearized reading' (duration: 126.374724ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:37.479309Z","caller":"traceutil/trace.go:171","msg":"trace[1970873109] linearizableReadLoop","detail":"{readStateIndex:1190; appliedIndex:1189; }","duration":"136.693919ms","start":"2026-04-14T07:49:37.342593Z","end":"2026-04-14T07:49:37.479287Z","steps":["trace[1970873109] 'read index received' (duration: 136.553326ms)","trace[1970873109] 'applied index is now lower than readState.Index' (duration: 139.643µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:37.479409Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.118792Z","time spent":"360.613933ms","remote":"127.0.0.1:49984","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-04-14T07:49:37.479496Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.884424ms","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-04-14T07:49:37.479542Z","caller":"traceutil/trace.go:171","msg":"trace[2115563937] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1146; }","duration":"136.977456ms","start":"2026-04-14T07:49:37.342552Z","end":"2026-04-14T07:49:37.479529Z","steps":["trace[2115563937] 'agreement among raft nodes before linearized reading' (duration: 136.823382ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:38.307679Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980081576,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-14T07:49:38.80891Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980081576,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-14T07:49:39.235007Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.569107472s","expected-duration":"1s"} {"level":"info","ts":"2026-04-14T07:49:39.235241Z","caller":"traceutil/trace.go:171","msg":"trace[124049210] transaction","detail":"{read_only:false; response_revision:1149; number_of_response:1; }","duration":"1.569440959s","start":"2026-04-14T07:49:37.665785Z","end":"2026-04-14T07:49:39.235226Z","steps":["trace[124049210] 'process raft request' (duration: 1.569356338s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.235333Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.665762Z","time spent":"1.569523433s","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:39.249536Z","caller":"traceutil/trace.go:171","msg":"trace[2007243037] linearizableReadLoop","detail":"{readStateIndex:1194; appliedIndex:1192; }","duration":"1.442143344s","start":"2026-04-14T07:49:37.807362Z","end":"2026-04-14T07:49:39.249505Z","steps":["trace[2007243037] 'read index received' (duration: 1.427805328s)","trace[2007243037] 'applied index is now lower than readState.Index' (duration: 14.336706ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:39.249569Z","caller":"traceutil/trace.go:171","msg":"trace[1514561188] transaction","detail":"{read_only:false; response_revision:1150; number_of_response:1; }","duration":"705.756844ms","start":"2026-04-14T07:49:38.543793Z","end":"2026-04-14T07:49:39.24955Z","steps":["trace[1514561188] 'process raft request' (duration: 705.55228ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.249667Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:38.543766Z","time spent":"705.849456ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:39.249795Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.44239879s","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-04-14T07:49:39.249841Z","caller":"traceutil/trace.go:171","msg":"trace[1689169167] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1150; }","duration":"1.442500693s","start":"2026-04-14T07:49:37.807327Z","end":"2026-04-14T07:49:39.249828Z","steps":["trace[1689169167] 'agreement among raft nodes before linearized reading' (duration: 1.442323949s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.249832Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.399813771s","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-04-14T07:49:39.249885Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.807313Z","time spent":"1.442562934s","remote":"127.0.0.1:50200","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-04-14T07:49:39.249888Z","caller":"traceutil/trace.go:171","msg":"trace[345574888] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1150; }","duration":"1.399890594s","start":"2026-04-14T07:49:37.849984Z","end":"2026-04-14T07:49:39.249875Z","steps":["trace[345574888] 'agreement among raft nodes before linearized reading' (duration: 1.39972147s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.249931Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.849976Z","time spent":"1.399946745s","remote":"127.0.0.1:50200","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-04-14T07:49:39.249925Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.410928975s","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":"warn","ts":"2026-04-14T07:49:39.249974Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.402116745s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:49:39.250024Z","caller":"traceutil/trace.go:171","msg":"trace[944689842] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1150; }","duration":"1.411080619s","start":"2026-04-14T07:49:37.838924Z","end":"2026-04-14T07:49:39.250004Z","steps":["trace[944689842] 'agreement among raft nodes before linearized reading' (duration: 1.410768032s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.250072Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.838907Z","time spent":"1.41115791s","remote":"127.0.0.1:50200","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-04-14T07:49:39.250067Z","caller":"traceutil/trace.go:171","msg":"trace[458435474] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1150; }","duration":"1.402270137s","start":"2026-04-14T07:49:37.847776Z","end":"2026-04-14T07:49:39.250046Z","steps":["trace[458435474] 'agreement among raft nodes before linearized reading' (duration: 1.40195723s)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:39.250116Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:37.847761Z","time spent":"1.40234633s","remote":"127.0.0.1:50200","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-04-14T07:49:54.813347Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.605489ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:54.813459Z","caller":"traceutil/trace.go:171","msg":"trace[60813681] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1215; }","duration":"162.765893ms","start":"2026-04-14T07:49:54.650673Z","end":"2026-04-14T07:49:54.813439Z","steps":["trace[60813681] 'range keys from in-memory index tree' (duration: 162.531937ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:54.813607Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.262998ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:5330"} {"level":"info","ts":"2026-04-14T07:49:54.813676Z","caller":"traceutil/trace.go:171","msg":"trace[1133740237] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:1215; }","duration":"124.368ms","start":"2026-04-14T07:49:54.689292Z","end":"2026-04-14T07:49:54.81366Z","steps":["trace[1133740237] 'range keys from in-memory index tree' (duration: 124.056442ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:55.080615Z","caller":"traceutil/trace.go:171","msg":"trace[1065644327] transaction","detail":"{read_only:false; response_revision:1216; number_of_response:1; }","duration":"259.046382ms","start":"2026-04-14T07:49:54.821545Z","end":"2026-04-14T07:49:55.080592Z","steps":["trace[1065644327] 'process raft request' (duration: 258.605852ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:55.242238Z","caller":"traceutil/trace.go:171","msg":"trace[1010505426] transaction","detail":"{read_only:false; response_revision:1217; number_of_response:1; }","duration":"153.127964ms","start":"2026-04-14T07:49:55.089088Z","end":"2026-04-14T07:49:55.242216Z","steps":["trace[1010505426] 'process raft request' (duration: 152.995371ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:55.289211Z","caller":"traceutil/trace.go:171","msg":"trace[1836085375] transaction","detail":"{read_only:false; response_revision:1218; number_of_response:1; }","duration":"194.818021ms","start":"2026-04-14T07:49:55.094371Z","end":"2026-04-14T07:49:55.289189Z","steps":["trace[1836085375] 'process raft request' (duration: 194.676987ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:55.782013Z","caller":"traceutil/trace.go:171","msg":"trace[446501930] transaction","detail":"{read_only:false; response_revision:1219; number_of_response:1; }","duration":"481.951963ms","start":"2026-04-14T07:49:55.300038Z","end":"2026-04-14T07:49:55.78199Z","steps":["trace[446501930] 'process raft request' (duration: 417.071278ms)","trace[446501930] 'compare' (duration: 64.784833ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:55.782143Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.300026Z","time spent":"482.049065ms","remote":"127.0.0.1:50212","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1507,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:56.219099Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.904023ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T07:49:56.219341Z","caller":"traceutil/trace.go:171","msg":"trace[2128756947] transaction","detail":"{read_only:false; response_revision:1220; number_of_response:1; }","duration":"919.275542ms","start":"2026-04-14T07:49:55.300034Z","end":"2026-04-14T07:49:56.219309Z","steps":["trace[2128756947] 'process raft request' (duration: 644.077521ms)","trace[2128756947] 'compare' (duration: 274.74685ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:56.219481Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.300015Z","time spent":"919.392394ms","remote":"127.0.0.1:50120","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":914,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:56.219479Z","caller":"traceutil/trace.go:171","msg":"trace[97376423] transaction","detail":"{read_only:false; response_revision:1221; number_of_response:1; }","duration":"919.418565ms","start":"2026-04-14T07:49:55.300039Z","end":"2026-04-14T07:49:56.219458Z","steps":["trace[97376423] 'process raft request' (duration: 919.150898ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.219579Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.300024Z","time spent":"919.502037ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:56.219359Z","caller":"traceutil/trace.go:171","msg":"trace[1651582788] linearizableReadLoop","detail":"{readStateIndex:1269; appliedIndex:1265; }","duration":"860.71676ms","start":"2026-04-14T07:49:55.358626Z","end":"2026-04-14T07:49:56.219342Z","steps":["trace[1651582788] 'read index received' (duration: 358.496295ms)","trace[1651582788] 'applied index is now lower than readState.Index' (duration: 502.219575ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:56.219882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"859.029351ms","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-04-14T07:49:56.219907Z","caller":"traceutil/trace.go:171","msg":"trace[2006571038] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1222; }","duration":"859.089102ms","start":"2026-04-14T07:49:55.360809Z","end":"2026-04-14T07:49:56.219898Z","steps":["trace[2006571038] 'agreement among raft nodes before linearized reading' (duration: 859.00241ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.219928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.360789Z","time spent":"859.134483ms","remote":"127.0.0.1:50200","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":"warn","ts":"2026-04-14T07:49:56.219973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"825.226102ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:56.220018Z","caller":"traceutil/trace.go:171","msg":"trace[717778796] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:1222; }","duration":"825.324914ms","start":"2026-04-14T07:49:55.39468Z","end":"2026-04-14T07:49:56.220005Z","steps":["trace[717778796] 'agreement among raft nodes before linearized reading' (duration: 825.245003ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"854.298003ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T07:49:56.22005Z","caller":"traceutil/trace.go:171","msg":"trace[1452313563] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1222; }","duration":"854.335813ms","start":"2026-04-14T07:49:55.365709Z","end":"2026-04-14T07:49:56.220045Z","steps":["trace[1452313563] 'agreement among raft nodes before linearized reading' (duration: 854.283242ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220054Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.394625Z","time spent":"825.420516ms","remote":"127.0.0.1:50796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:49:56.220066Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.365698Z","time spent":"854.364384ms","remote":"127.0.0.1:50200","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-04-14T07:49:56.22016Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"856.338399ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:49:56.220176Z","caller":"traceutil/trace.go:171","msg":"trace[1844896779] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1222; }","duration":"856.39853ms","start":"2026-04-14T07:49:55.363772Z","end":"2026-04-14T07:49:56.220171Z","steps":["trace[1844896779] 'agreement among raft nodes before linearized reading' (duration: 856.355499ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220193Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.363747Z","time spent":"856.442342ms","remote":"127.0.0.1:50200","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-04-14T07:49:56.220213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"484.482241ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:56.220243Z","caller":"traceutil/trace.go:171","msg":"trace[69119109] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:1222; }","duration":"484.547582ms","start":"2026-04-14T07:49:55.735686Z","end":"2026-04-14T07:49:56.220234Z","steps":["trace[69119109] 'agreement among raft nodes before linearized reading' (duration: 484.50059ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220272Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.735664Z","time spent":"484.599873ms","remote":"127.0.0.1:50104","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":29,"request content":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:49:56.220434Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"664.389303ms","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-04-14T07:49:56.22046Z","caller":"traceutil/trace.go:171","msg":"trace[1249945339] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1222; }","duration":"664.431683ms","start":"2026-04-14T07:49:55.556017Z","end":"2026-04-14T07:49:56.220449Z","steps":["trace[1249945339] 'agreement among raft nodes before linearized reading' (duration: 664.378622ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220482Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.556003Z","time spent":"664.474085ms","remote":"127.0.0.1:50200","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":"info","ts":"2026-04-14T07:49:56.220604Z","caller":"traceutil/trace.go:171","msg":"trace[1173345820] transaction","detail":"{read_only:false; response_revision:1222; number_of_response:1; }","duration":"920.266844ms","start":"2026-04-14T07:49:55.300327Z","end":"2026-04-14T07:49:56.220594Z","steps":["trace[1173345820] 'process raft request' (duration: 918.945853ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.220656Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.300321Z","time spent":"920.302714ms","remote":"127.0.0.1:50408","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9375,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:56.221805Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"863.171614ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:49:56.221857Z","caller":"traceutil/trace.go:171","msg":"trace[328354701] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1222; }","duration":"863.262427ms","start":"2026-04-14T07:49:55.358581Z","end":"2026-04-14T07:49:56.221843Z","steps":["trace[328354701] 'agreement among raft nodes before linearized reading' (duration: 860.806642ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.222374Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:55.358563Z","time spent":"863.796609ms","remote":"127.0.0.1:50200","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":"info","ts":"2026-04-14T07:49:56.689387Z","caller":"traceutil/trace.go:171","msg":"trace[1269064197] transaction","detail":"{read_only:false; response_revision:1223; number_of_response:1; }","duration":"464.601228ms","start":"2026-04-14T07:49:56.224747Z","end":"2026-04-14T07:49:56.689348Z","steps":["trace[1269064197] 'process raft request' (duration: 427.225738ms)","trace[1269064197] 'compare' (duration: 37.174146ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:56.68956Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:56.224722Z","time spent":"464.751192ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:56.879083Z","caller":"traceutil/trace.go:171","msg":"trace[1969195444] transaction","detail":"{read_only:false; response_revision:1225; number_of_response:1; }","duration":"649.809511ms","start":"2026-04-14T07:49:56.229251Z","end":"2026-04-14T07:49:56.87906Z","steps":["trace[1969195444] 'process raft request' (duration: 649.699688ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:56.879097Z","caller":"traceutil/trace.go:171","msg":"trace[1874280830] transaction","detail":"{read_only:false; response_revision:1224; number_of_response:1; }","duration":"653.192368ms","start":"2026-04-14T07:49:56.225871Z","end":"2026-04-14T07:49:56.879063Z","steps":["trace[1874280830] 'process raft request' (duration: 641.063642ms)","trace[1874280830] 'compare' (duration: 11.801629ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:56.879208Z","caller":"traceutil/trace.go:171","msg":"trace[1600594257] linearizableReadLoop","detail":"{readStateIndex:1274; appliedIndex:1269; }","duration":"228.808705ms","start":"2026-04-14T07:49:56.650365Z","end":"2026-04-14T07:49:56.879174Z","steps":["trace[1600594257] 'read index received' (duration: 1.616257ms)","trace[1600594257] 'applied index is now lower than readState.Index' (duration: 227.191628ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:49:56.879244Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:56.225846Z","time spent":"653.316931ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:56.879323Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.946078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:49:56.879331Z","caller":"traceutil/trace.go:171","msg":"trace[1900329622] transaction","detail":"{read_only:false; response_revision:1226; number_of_response:1; }","duration":"650.071427ms","start":"2026-04-14T07:49:56.229237Z","end":"2026-04-14T07:49:56.879308Z","steps":["trace[1900329622] 'process raft request' (duration: 649.788771ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:56.879357Z","caller":"traceutil/trace.go:171","msg":"trace[1175012845] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1227; }","duration":"229.02685ms","start":"2026-04-14T07:49:56.650318Z","end":"2026-04-14T07:49:56.879345Z","steps":["trace[1175012845] 'agreement among raft nodes before linearized reading' (duration: 228.942398ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:56.879358Z","caller":"traceutil/trace.go:171","msg":"trace[1453812894] transaction","detail":"{read_only:false; response_revision:1227; number_of_response:1; }","duration":"650.019086ms","start":"2026-04-14T07:49:56.229322Z","end":"2026-04-14T07:49:56.879341Z","steps":["trace[1453812894] 'process raft request' (duration: 649.793541ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:56.879399Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:56.229236Z","time spent":"649.913264ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:56.879421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:56.229214Z","time spent":"650.161209ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:49:56.879443Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:56.229309Z","time spent":"650.079197ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:58.527251Z","caller":"traceutil/trace.go:171","msg":"trace[612352119] transaction","detail":"{read_only:false; response_revision:1230; number_of_response:1; }","duration":"300.644359ms","start":"2026-04-14T07:49:58.226294Z","end":"2026-04-14T07:49:58.526938Z","steps":["trace[612352119] 'process raft request' (duration: 300.465485ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:58.527457Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:58.226267Z","time spent":"301.068267ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:59.179107Z","caller":"traceutil/trace.go:171","msg":"trace[662102320] linearizableReadLoop","detail":"{readStateIndex:1279; appliedIndex:1278; }","duration":"294.414407ms","start":"2026-04-14T07:49:58.884669Z","end":"2026-04-14T07:49:59.179083Z","steps":["trace[662102320] 'read index received' (duration: 294.163922ms)","trace[662102320] 'applied index is now lower than readState.Index' (duration: 249.565µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:49:59.17942Z","caller":"traceutil/trace.go:171","msg":"trace[1043425870] transaction","detail":"{read_only:false; response_revision:1231; number_of_response:1; }","duration":"481.467122ms","start":"2026-04-14T07:49:58.697916Z","end":"2026-04-14T07:49:59.179383Z","steps":["trace[1043425870] 'process raft request' (duration: 480.989411ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:59.179563Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.865897ms","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-04-14T07:49:59.179593Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:49:58.697897Z","time spent":"481.608495ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:49:59.179624Z","caller":"traceutil/trace.go:171","msg":"trace[889212556] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1231; }","duration":"294.952539ms","start":"2026-04-14T07:49:58.884641Z","end":"2026-04-14T07:49:59.179594Z","steps":["trace[889212556] 'agreement among raft nodes before linearized reading' (duration: 294.755564ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:59.179775Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.02114ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T07:49:59.179848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.153402ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-14T07:49:59.179853Z","caller":"traceutil/trace.go:171","msg":"trace[941561841] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1231; }","duration":"295.150583ms","start":"2026-04-14T07:49:58.884684Z","end":"2026-04-14T07:49:59.179835Z","steps":["trace[941561841] 'agreement among raft nodes before linearized reading' (duration: 294.959299ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:59.179885Z","caller":"traceutil/trace.go:171","msg":"trace[1479826638] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:1231; }","duration":"240.229554ms","start":"2026-04-14T07:49:58.939645Z","end":"2026-04-14T07:49:59.179875Z","steps":["trace[1479826638] 'agreement among raft nodes before linearized reading' (duration: 240.177173ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:59.179803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.99927ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T07:49:59.18003Z","caller":"traceutil/trace.go:171","msg":"trace[1491553824] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1231; }","duration":"295.257696ms","start":"2026-04-14T07:49:58.884759Z","end":"2026-04-14T07:49:59.180017Z","steps":["trace[1491553824] 'agreement among raft nodes before linearized reading' (duration: 294.98463ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:49:59.180622Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.739097ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:49:59.180935Z","caller":"traceutil/trace.go:171","msg":"trace[966972804] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1231; }","duration":"296.064105ms","start":"2026-04-14T07:49:58.884702Z","end":"2026-04-14T07:49:59.180766Z","steps":["trace[966972804] 'agreement among raft nodes before linearized reading' (duration: 295.319937ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:59.349546Z","caller":"traceutil/trace.go:171","msg":"trace[623880079] transaction","detail":"{read_only:false; response_revision:1235; number_of_response:1; }","duration":"158.437314ms","start":"2026-04-14T07:49:59.191092Z","end":"2026-04-14T07:49:59.34953Z","steps":["trace[623880079] 'process raft request' (duration: 158.413884ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:59.349902Z","caller":"traceutil/trace.go:171","msg":"trace[1160668199] transaction","detail":"{read_only:false; response_revision:1233; number_of_response:1; }","duration":"160.177304ms","start":"2026-04-14T07:49:59.189719Z","end":"2026-04-14T07:49:59.349896Z","steps":["trace[1160668199] 'process raft request' (duration: 159.664212ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:59.349978Z","caller":"traceutil/trace.go:171","msg":"trace[988704146] transaction","detail":"{read_only:false; response_revision:1234; number_of_response:1; }","duration":"159.969948ms","start":"2026-04-14T07:49:59.190003Z","end":"2026-04-14T07:49:59.349973Z","steps":["trace[988704146] 'process raft request' (duration: 159.484167ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:49:59.647353Z","caller":"traceutil/trace.go:171","msg":"trace[1423814777] transaction","detail":"{read_only:false; response_revision:1239; number_of_response:1; }","duration":"122.813134ms","start":"2026-04-14T07:49:59.52451Z","end":"2026-04-14T07:49:59.647324Z","steps":["trace[1423814777] 'process raft request' (duration: 69.917481ms)","trace[1423814777] 'compare' (duration: 52.705609ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:50:01.039348Z","caller":"traceutil/trace.go:171","msg":"trace[989801447] linearizableReadLoop","detail":"{readStateIndex:1291; appliedIndex:1290; }","duration":"414.806755ms","start":"2026-04-14T07:50:00.62452Z","end":"2026-04-14T07:50:01.039327Z","steps":["trace[989801447] 'read index received' (duration: 414.58376ms)","trace[989801447] 'applied index is now lower than readState.Index' (duration: 222.285µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:50:01.039459Z","caller":"traceutil/trace.go:171","msg":"trace[184901938] transaction","detail":"{read_only:false; response_revision:1243; number_of_response:1; }","duration":"506.730407ms","start":"2026-04-14T07:50:00.532718Z","end":"2026-04-14T07:50:01.039449Z","steps":["trace[184901938] 'process raft request' (duration: 506.469241ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:01.039562Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:00.532701Z","time spent":"506.784578ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:50:01.039805Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"415.282475ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:50:01.039857Z","caller":"traceutil/trace.go:171","msg":"trace[95635804] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1243; }","duration":"415.359478ms","start":"2026-04-14T07:50:00.624484Z","end":"2026-04-14T07:50:01.039844Z","steps":["trace[95635804] 'agreement among raft nodes before linearized reading' (duration: 415.285256ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:01.03994Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:00.624467Z","time spent":"415.463019ms","remote":"127.0.0.1:49962","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-04-14T07:50:01.040149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.662402ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:50:01.040231Z","caller":"traceutil/trace.go:171","msg":"trace[1899246355] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1243; }","duration":"392.766634ms","start":"2026-04-14T07:50:00.647442Z","end":"2026-04-14T07:50:01.040209Z","steps":["trace[1899246355] 'agreement among raft nodes before linearized reading' (duration: 392.653431ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:01.040275Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:00.647426Z","time spent":"392.841445ms","remote":"127.0.0.1:49960","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-04-14T07:50:01.36286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.735997ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:50:01.362923Z","caller":"traceutil/trace.go:171","msg":"trace[604027753] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1243; }","duration":"153.804919ms","start":"2026-04-14T07:50:01.209103Z","end":"2026-04-14T07:50:01.362908Z","steps":["trace[604027753] 'range keys from in-memory index tree' (duration: 153.649705ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:01.363684Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.357306ms","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-04-14T07:50:01.363748Z","caller":"traceutil/trace.go:171","msg":"trace[971471862] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1243; }","duration":"174.492408ms","start":"2026-04-14T07:50:01.18924Z","end":"2026-04-14T07:50:01.363733Z","steps":["trace[971471862] 'range keys from in-memory index tree' (duration: 174.216962ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:03.530225Z","caller":"traceutil/trace.go:171","msg":"trace[1078329838] linearizableReadLoop","detail":"{readStateIndex:1306; appliedIndex:1305; }","duration":"120.938611ms","start":"2026-04-14T07:50:03.409263Z","end":"2026-04-14T07:50:03.530202Z","steps":["trace[1078329838] 'read index received' (duration: 120.694265ms)","trace[1078329838] 'applied index is now lower than readState.Index' (duration: 243.396µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:50:03.530595Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.310289ms","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-04-14T07:50:03.530651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.335519ms","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-04-14T07:50:03.530678Z","caller":"traceutil/trace.go:171","msg":"trace[1512654207] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1257; }","duration":"121.439612ms","start":"2026-04-14T07:50:03.409219Z","end":"2026-04-14T07:50:03.530658Z","steps":["trace[1512654207] 'agreement among raft nodes before linearized reading' (duration: 121.183476ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:03.53069Z","caller":"traceutil/trace.go:171","msg":"trace[209187232] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1257; }","duration":"121.428371ms","start":"2026-04-14T07:50:03.40925Z","end":"2026-04-14T07:50:03.530678Z","steps":["trace[209187232] 'agreement among raft nodes before linearized reading' (duration: 121.279498ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:03.530823Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.44708ms","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-04-14T07:50:03.530894Z","caller":"traceutil/trace.go:171","msg":"trace[1404908919] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1257; }","duration":"120.552123ms","start":"2026-04-14T07:50:03.410325Z","end":"2026-04-14T07:50:03.530878Z","steps":["trace[1404908919] 'agreement among raft nodes before linearized reading' (duration: 120.304816ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:03.530889Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.514211ms","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-04-14T07:50:03.530954Z","caller":"traceutil/trace.go:171","msg":"trace[337861518] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1257; }","duration":"120.616954ms","start":"2026-04-14T07:50:03.410324Z","end":"2026-04-14T07:50:03.530941Z","steps":["trace[337861518] 'agreement among raft nodes before linearized reading' (duration: 120.336867ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:03.531184Z","caller":"traceutil/trace.go:171","msg":"trace[2072835026] transaction","detail":"{read_only:false; response_revision:1257; number_of_response:1; }","duration":"139.585224ms","start":"2026-04-14T07:50:03.391019Z","end":"2026-04-14T07:50:03.530604Z","steps":["trace[2072835026] 'process raft request' (duration: 139.038842ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:09.745333Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":18421303070980081890,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-14T07:50:10.027115Z","caller":"traceutil/trace.go:171","msg":"trace[2026283816] linearizableReadLoop","detail":"{readStateIndex:1356; appliedIndex:1355; }","duration":"782.319155ms","start":"2026-04-14T07:50:09.244771Z","end":"2026-04-14T07:50:10.02709Z","steps":["trace[2026283816] 'read index received' (duration: 782.196442ms)","trace[2026283816] 'applied index is now lower than readState.Index' (duration: 121.663µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:50:10.027246Z","caller":"traceutil/trace.go:171","msg":"trace[815233072] transaction","detail":"{read_only:false; response_revision:1306; number_of_response:1; }","duration":"956.991698ms","start":"2026-04-14T07:50:09.070243Z","end":"2026-04-14T07:50:10.027234Z","steps":["trace[815233072] 'process raft request' (duration: 956.690721ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.027348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.070201Z","time spent":"957.071251ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:50:10.027623Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"782.830217ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:533"} {"level":"info","ts":"2026-04-14T07:50:10.027696Z","caller":"traceutil/trace.go:171","msg":"trace[1124012042] range","detail":"{range_begin:/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1306; }","duration":"782.96283ms","start":"2026-04-14T07:50:09.244721Z","end":"2026-04-14T07:50:10.027683Z","steps":["trace[1124012042] 'agreement among raft nodes before linearized reading' (duration: 782.777046ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.027735Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.244702Z","time spent":"783.017631ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":75,"response count":1,"response size":557,"request content":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-04-14T07:50:10.292435Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.470408ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T07:50:10.292576Z","caller":"traceutil/trace.go:171","msg":"trace[1017421526] linearizableReadLoop","detail":"{readStateIndex:1357; appliedIndex:1356; }","duration":"265.344677ms","start":"2026-04-14T07:50:10.027201Z","end":"2026-04-14T07:50:10.292546Z","steps":["trace[1017421526] 'read index received' (duration: 94.662164ms)","trace[1017421526] 'applied index is now lower than readState.Index' (duration: 170.681413ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:50:10.292913Z","caller":"traceutil/trace.go:171","msg":"trace[1142021333] transaction","detail":"{read_only:false; response_revision:1307; number_of_response:1; }","duration":"323.994179ms","start":"2026-04-14T07:50:09.968866Z","end":"2026-04-14T07:50:10.29286Z","steps":["trace[1142021333] 'process raft request' (duration: 153.016759ms)","trace[1142021333] 'compare' (duration: 170.331955ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:50:10.292984Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.96885Z","time spent":"324.100782ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:50:10.293197Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.363803ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-14T07:50:10.293241Z","caller":"traceutil/trace.go:171","msg":"trace[2006979802] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:1307; }","duration":"326.443865ms","start":"2026-04-14T07:50:09.966784Z","end":"2026-04-14T07:50:10.293228Z","steps":["trace[2006979802] 'agreement among raft nodes before linearized reading' (duration: 326.375684ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.293272Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.966761Z","time spent":"326.502707ms","remote":"127.0.0.1:50438","response type":"/etcdserverpb.KV/Range","request count":0,"request size":86,"response count":1,"response size":31,"request content":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-04-14T07:50:10.293417Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.035417ms","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-04-14T07:50:10.293501Z","caller":"traceutil/trace.go:171","msg":"trace[68276596] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1307; }","duration":"727.206592ms","start":"2026-04-14T07:50:09.566276Z","end":"2026-04-14T07:50:10.293482Z","steps":["trace[68276596] 'agreement among raft nodes before linearized reading' (duration: 726.930865ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.293535Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"741.131199ms","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":"warn","ts":"2026-04-14T07:50:10.293555Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.566247Z","time spent":"727.294234ms","remote":"127.0.0.1:50200","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":"info","ts":"2026-04-14T07:50:10.293676Z","caller":"traceutil/trace.go:171","msg":"trace[1273050960] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1307; }","duration":"741.334833ms","start":"2026-04-14T07:50:09.552312Z","end":"2026-04-14T07:50:10.293647Z","steps":["trace[1273050960] 'agreement among raft nodes before linearized reading' (duration: 740.898803ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.293797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"469.490831ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:532"} {"level":"info","ts":"2026-04-14T07:50:10.293842Z","caller":"traceutil/trace.go:171","msg":"trace[1414874933] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:1307; }","duration":"469.578223ms","start":"2026-04-14T07:50:09.824251Z","end":"2026-04-14T07:50:10.293829Z","steps":["trace[1414874933] 'agreement among raft nodes before linearized reading' (duration: 469.45789ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.293873Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.824229Z","time spent":"469.637463ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":1,"response size":556,"request content":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" "} {"level":"warn","ts":"2026-04-14T07:50:10.293978Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"722.108367ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:50:10.294024Z","caller":"traceutil/trace.go:171","msg":"trace[1923077152] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1307; }","duration":"722.196019ms","start":"2026-04-14T07:50:09.571815Z","end":"2026-04-14T07:50:10.294011Z","steps":["trace[1923077152] 'agreement among raft nodes before linearized reading' (duration: 722.062816ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.294053Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.571788Z","time spent":"722.259329ms","remote":"127.0.0.1:50200","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-04-14T07:50:10.294072Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.55229Z","time spent":"741.452147ms","remote":"127.0.0.1:50200","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-04-14T07:50:10.29412Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.415797ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T07:50:10.294167Z","caller":"traceutil/trace.go:171","msg":"trace[659716451] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1307; }","duration":"727.481869ms","start":"2026-04-14T07:50:09.566675Z","end":"2026-04-14T07:50:10.294157Z","steps":["trace[659716451] 'agreement among raft nodes before linearized reading' (duration: 727.368596ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.294205Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.566664Z","time spent":"727.53373ms","remote":"127.0.0.1:50200","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-04-14T07:50:10.294237Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"628.513217ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:474"} {"level":"info","ts":"2026-04-14T07:50:10.294276Z","caller":"traceutil/trace.go:171","msg":"trace[704553857] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1307; }","duration":"628.576229ms","start":"2026-04-14T07:50:09.66569Z","end":"2026-04-14T07:50:10.294266Z","steps":["trace[704553857] 'agreement among raft nodes before linearized reading' (duration: 628.487067ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.294306Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.665665Z","time spent":"628.63444ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":498,"request content":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-04-14T07:50:10.294468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"733.257579ms","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-04-14T07:50:10.294824Z","caller":"traceutil/trace.go:171","msg":"trace[355272854] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1307; }","duration":"733.654418ms","start":"2026-04-14T07:50:09.561146Z","end":"2026-04-14T07:50:10.2948Z","steps":["trace[355272854] 'agreement among raft nodes before linearized reading' (duration: 732.540893ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.29501Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:09.561124Z","time spent":"733.870754ms","remote":"127.0.0.1:50200","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-04-14T07:50:10.340049Z","caller":"traceutil/trace.go:171","msg":"trace[1101691846] transaction","detail":"{read_only:false; response_revision:1308; number_of_response:1; }","duration":"306.047852ms","start":"2026-04-14T07:50:10.03397Z","end":"2026-04-14T07:50:10.340018Z","steps":["trace[1101691846] 'process raft request' (duration: 305.874518ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.340343Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"248.845191ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T07:50:10.340435Z","caller":"traceutil/trace.go:171","msg":"trace[1453710799] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:1308; }","duration":"249.035115ms","start":"2026-04-14T07:50:10.091378Z","end":"2026-04-14T07:50:10.340413Z","steps":["trace[1453710799] 'agreement among raft nodes before linearized reading' (duration: 248.8351ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:50:10.340479Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:50:10.03395Z","time spent":"306.261046ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":518,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T07:50:12.466207Z","caller":"traceutil/trace.go:171","msg":"trace[1226242297] linearizableReadLoop","detail":"{readStateIndex:1372; appliedIndex:1368; }","duration":"103.697059ms","start":"2026-04-14T07:50:12.362472Z","end":"2026-04-14T07:50:12.466169Z","steps":["trace[1226242297] 'read index received' (duration: 70.249258ms)","trace[1226242297] 'applied index is now lower than readState.Index' (duration: 33.446381ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:50:12.466574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.003766ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T07:50:12.466622Z","caller":"traceutil/trace.go:171","msg":"trace[56275864] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1322; }","duration":"104.160729ms","start":"2026-04-14T07:50:12.362448Z","end":"2026-04-14T07:50:12.466609Z","steps":["trace[56275864] 'agreement among raft nodes before linearized reading' (duration: 103.864322ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:12.466631Z","caller":"traceutil/trace.go:171","msg":"trace[2117053485] transaction","detail":"{read_only:false; response_revision:1320; number_of_response:1; }","duration":"106.398221ms","start":"2026-04-14T07:50:12.360186Z","end":"2026-04-14T07:50:12.466585Z","steps":["trace[2117053485] 'process raft request' (duration: 105.828668ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:12.466872Z","caller":"traceutil/trace.go:171","msg":"trace[752170034] transaction","detail":"{read_only:false; response_revision:1319; number_of_response:1; }","duration":"107.460434ms","start":"2026-04-14T07:50:12.359341Z","end":"2026-04-14T07:50:12.466801Z","steps":["trace[752170034] 'process raft request' (duration: 106.480353ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:12.466905Z","caller":"traceutil/trace.go:171","msg":"trace[78109219] transaction","detail":"{read_only:false; response_revision:1321; number_of_response:1; }","duration":"105.155631ms","start":"2026-04-14T07:50:12.361737Z","end":"2026-04-14T07:50:12.466893Z","steps":["trace[78109219] 'process raft request' (duration: 104.327403ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:50:12.466896Z","caller":"traceutil/trace.go:171","msg":"trace[1269137861] transaction","detail":"{read_only:false; response_revision:1322; number_of_response:1; }","duration":"103.842532ms","start":"2026-04-14T07:50:12.363027Z","end":"2026-04-14T07:50:12.46687Z","steps":["trace[1269137861] 'process raft request' (duration: 103.085735ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:51:03.065017Z","caller":"traceutil/trace.go:171","msg":"trace[1824621408] transaction","detail":"{read_only:false; response_revision:1552; number_of_response:1; }","duration":"112.98832ms","start":"2026-04-14T07:51:02.951994Z","end":"2026-04-14T07:51:03.064982Z","steps":["trace[1824621408] 'process raft request' (duration: 73.112698ms)","trace[1824621408] 'compare' (duration: 39.657788ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:51:03.065131Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.365317ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:51:03.065219Z","caller":"traceutil/trace.go:171","msg":"trace[848881867] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1552; }","duration":"112.488309ms","start":"2026-04-14T07:51:02.95271Z","end":"2026-04-14T07:51:03.065199Z","steps":["trace[848881867] 'agreement among raft nodes before linearized reading' (duration: 112.270724ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:51:05.271105Z","caller":"traceutil/trace.go:171","msg":"trace[1668042558] linearizableReadLoop","detail":"{readStateIndex:1622; appliedIndex:1621; }","duration":"183.787328ms","start":"2026-04-14T07:51:05.08726Z","end":"2026-04-14T07:51:05.271048Z","steps":["trace[1668042558] 'read index received' (duration: 89.132673ms)","trace[1668042558] 'applied index is now lower than readState.Index' (duration: 94.652445ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:51:05.271484Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.190886ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T07:51:05.27128Z","caller":"traceutil/trace.go:171","msg":"trace[603558006] transaction","detail":"{read_only:false; response_revision:1561; number_of_response:1; }","duration":"188.290227ms","start":"2026-04-14T07:51:05.082939Z","end":"2026-04-14T07:51:05.27123Z","steps":["trace[603558006] 'process raft request' (duration: 93.611191ms)","trace[603558006] 'compare' (duration: 94.227656ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:51:05.271553Z","caller":"traceutil/trace.go:171","msg":"trace[1035040723] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1561; }","duration":"184.328259ms","start":"2026-04-14T07:51:05.087203Z","end":"2026-04-14T07:51:05.271531Z","steps":["trace[1035040723] 'agreement among raft nodes before linearized reading' (duration: 184.032703ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:51:09.174129Z","caller":"traceutil/trace.go:171","msg":"trace[1673600681] transaction","detail":"{read_only:false; response_revision:1579; number_of_response:1; }","duration":"114.126486ms","start":"2026-04-14T07:51:09.059963Z","end":"2026-04-14T07:51:09.17409Z","steps":["trace[1673600681] 'process raft request' (duration: 55.594141ms)","trace[1673600681] 'compare' (duration: 58.122346ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:51:21.221108Z","caller":"traceutil/trace.go:171","msg":"trace[1800408502] transaction","detail":"{read_only:false; response_revision:1634; number_of_response:1; }","duration":"121.619891ms","start":"2026-04-14T07:51:21.099468Z","end":"2026-04-14T07:51:21.221088Z","steps":["trace[1800408502] 'process raft request' (duration: 113.059422ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:51:51.640649Z","caller":"traceutil/trace.go:171","msg":"trace[1463409115] transaction","detail":"{read_only:false; response_revision:1774; number_of_response:1; }","duration":"204.812604ms","start":"2026-04-14T07:51:51.435809Z","end":"2026-04-14T07:51:51.640621Z","steps":["trace[1463409115] 'process raft request' (duration: 200.401777ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:52:42.04698Z","caller":"traceutil/trace.go:171","msg":"trace[1966468783] transaction","detail":"{read_only:false; response_revision:2006; number_of_response:1; }","duration":"120.497675ms","start":"2026-04-14T07:52:41.926442Z","end":"2026-04-14T07:52:42.04694Z","steps":["trace[1966468783] 'process raft request' (duration: 119.725827ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:52:42.047293Z","caller":"traceutil/trace.go:171","msg":"trace[1265728342] transaction","detail":"{read_only:false; response_revision:2007; number_of_response:1; }","duration":"119.249327ms","start":"2026-04-14T07:52:41.928017Z","end":"2026-04-14T07:52:42.047266Z","steps":["trace[1265728342] 'process raft request' (duration: 118.772307ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:53:21.216454Z","caller":"traceutil/trace.go:171","msg":"trace[262130295] linearizableReadLoop","detail":"{readStateIndex:2295; appliedIndex:2294; }","duration":"315.122387ms","start":"2026-04-14T07:53:20.901306Z","end":"2026-04-14T07:53:21.216428Z","steps":["trace[262130295] 'read index received' (duration: 314.944793ms)","trace[262130295] 'applied index is now lower than readState.Index' (duration: 176.244µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T07:53:21.21657Z","caller":"traceutil/trace.go:171","msg":"trace[1953678991] transaction","detail":"{read_only:false; response_revision:2206; number_of_response:1; }","duration":"367.945122ms","start":"2026-04-14T07:53:20.848562Z","end":"2026-04-14T07:53:21.216507Z","steps":["trace[1953678991] 'process raft request' (duration: 367.703996ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:53:21.216745Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:53:20.848524Z","time spent":"368.127086ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":519,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T07:53:21.21695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"315.602098ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:474"} {"level":"info","ts":"2026-04-14T07:53:21.217069Z","caller":"traceutil/trace.go:171","msg":"trace[1943341562] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2206; }","duration":"315.789422ms","start":"2026-04-14T07:53:20.901251Z","end":"2026-04-14T07:53:21.21704Z","steps":["trace[1943341562] 'agreement among raft nodes before linearized reading' (duration: 315.336852ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:53:21.217128Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T07:53:20.901227Z","time spent":"315.891984ms","remote":"127.0.0.1:50200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":498,"request content":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" "} {"level":"info","ts":"2026-04-14T07:53:21.219339Z","caller":"traceutil/trace.go:171","msg":"trace[247217717] transaction","detail":"{read_only:false; response_revision:2207; number_of_response:1; }","duration":"229.455899ms","start":"2026-04-14T07:53:20.989827Z","end":"2026-04-14T07:53:21.219283Z","steps":["trace[247217717] 'process raft request' (duration: 229.250035ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:53:27.974257Z","caller":"traceutil/trace.go:171","msg":"trace[1579900560] transaction","detail":"{read_only:false; response_revision:2243; number_of_response:1; }","duration":"262.043296ms","start":"2026-04-14T07:53:27.712164Z","end":"2026-04-14T07:53:27.974207Z","steps":["trace[1579900560] 'process raft request' (duration: 261.887523ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T07:53:28.133599Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.680867ms","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-04-14T07:53:28.13369Z","caller":"traceutil/trace.go:171","msg":"trace[967654930] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2243; }","duration":"119.81766ms","start":"2026-04-14T07:53:28.013851Z","end":"2026-04-14T07:53:28.133669Z","steps":["trace[967654930] 'range keys from in-memory index tree' (duration: 119.513664ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:53:28.269703Z","caller":"traceutil/trace.go:171","msg":"trace[695676317] transaction","detail":"{read_only:false; response_revision:2244; number_of_response:1; }","duration":"132.20991ms","start":"2026-04-14T07:53:28.13747Z","end":"2026-04-14T07:53:28.26968Z","steps":["trace[695676317] 'process raft request' (duration: 132.091127ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:53:28.298695Z","caller":"traceutil/trace.go:171","msg":"trace[12241894] linearizableReadLoop","detail":"{readStateIndex:2336; appliedIndex:2334; }","duration":"129.908417ms","start":"2026-04-14T07:53:28.168764Z","end":"2026-04-14T07:53:28.298673Z","steps":["trace[12241894] 'read index received' (duration: 100.734258ms)","trace[12241894] 'applied index is now lower than readState.Index' (duration: 29.173049ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T07:53:28.298935Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.155233ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T07:53:28.298985Z","caller":"traceutil/trace.go:171","msg":"trace[327094114] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2245; }","duration":"130.227755ms","start":"2026-04-14T07:53:28.168746Z","end":"2026-04-14T07:53:28.298974Z","steps":["trace[327094114] 'agreement among raft nodes before linearized reading' (duration: 130.02477ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T07:53:28.299282Z","caller":"traceutil/trace.go:171","msg":"trace[1301525477] transaction","detail":"{read_only:false; response_revision:2245; number_of_response:1; }","duration":"161.206865ms","start":"2026-04-14T07:53:28.138041Z","end":"2026-04-14T07:53:28.299248Z","steps":["trace[1301525477] 'process raft request' (duration: 160.51212ms)"],"step_count":1}