{"level":"warn","ts":"2026-04-01T15:04:57.091148Z","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-01T15:04:57.091268Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.65: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.65:2380","--initial-cluster=instance=https://199.204.45.65:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.65:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.65: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-01T15:04:57.091347Z","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-01T15:04:57.091356Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.65:2380"]} {"level":"info","ts":"2026-04-01T15:04:57.091371Z","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-01T15:04:57.092123Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"]} {"level":"info","ts":"2026-04-01T15:04:57.092212Z","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.65:2380"],"listen-peer-urls":["https://199.204.45.65:2380"],"advertise-client-urls":["https://199.204.45.65:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.65: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-01T15:04:57.097395Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.919307ms"} {"level":"info","ts":"2026-04-01T15:04:57.114983Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"cf8c3a138c9a77a2","cluster-id":"c278183e1f634dff"} {"level":"info","ts":"2026-04-01T15:04:57.115072Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=()"} {"level":"info","ts":"2026-04-01T15:04:57.115091Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 0"} {"level":"info","ts":"2026-04-01T15:04:57.115101Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft cf8c3a138c9a77a2 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-01T15:04:57.115108Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 1"} {"level":"info","ts":"2026-04-01T15:04:57.115142Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"} {"level":"warn","ts":"2026-04-01T15:04:57.128624Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-01T15:04:57.130192Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-01T15:04:57.13134Z","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-01T15:04:57.139049Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"cf8c3a138c9a77a2","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-01T15:04:57.140278Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"cf8c3a138c9a77a2","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-01T15:04:57.140369Z","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-01T15:04:57.140496Z","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-01T15:04:57.14051Z","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-01T15:04:57.141742Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"} {"level":"info","ts":"2026-04-01T15:04:57.142238Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"c278183e1f634dff","local-member-id":"cf8c3a138c9a77a2","added-peer-id":"cf8c3a138c9a77a2","added-peer-peer-urls":["https://199.204.45.65:2380"]} {"level":"info","ts":"2026-04-01T15:04:57.144169Z","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-01T15:04:57.144241Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.65:2380"} {"level":"info","ts":"2026-04-01T15:04:57.144339Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.65:2380"} {"level":"info","ts":"2026-04-01T15:04:57.144561Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"cf8c3a138c9a77a2","initial-advertise-peer-urls":["https://199.204.45.65:2380"],"listen-peer-urls":["https://199.204.45.65:2380"],"advertise-client-urls":["https://199.204.45.65:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-01T15:04:57.144614Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-01T15:04:57.415794Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 is starting a new election at term 1"} {"level":"info","ts":"2026-04-01T15:04:57.415842Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-01T15:04:57.415868Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgPreVoteResp from cf8c3a138c9a77a2 at term 1"} {"level":"info","ts":"2026-04-01T15:04:57.415883Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became candidate at term 2"} {"level":"info","ts":"2026-04-01T15:04:57.415892Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgVoteResp from cf8c3a138c9a77a2 at term 2"} {"level":"info","ts":"2026-04-01T15:04:57.41591Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became leader at term 2"} {"level":"info","ts":"2026-04-01T15:04:57.415948Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: cf8c3a138c9a77a2 elected leader cf8c3a138c9a77a2 at term 2"} {"level":"info","ts":"2026-04-01T15:04:57.417013Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-01T15:04:57.417865Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-01T15:04:57.417857Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"cf8c3a138c9a77a2","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.65:2379]}","request-path":"/0/members/cf8c3a138c9a77a2/attributes","cluster-id":"c278183e1f634dff","publish-timeout":"7s"} {"level":"info","ts":"2026-04-01T15:04:57.417905Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-01T15:04:57.41825Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"c278183e1f634dff","local-member-id":"cf8c3a138c9a77a2","cluster-version":"3.5"} {"level":"info","ts":"2026-04-01T15:04:57.418309Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-01T15:04:57.418335Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-01T15:04:57.418413Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-01T15:04:57.418494Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-01T15:04:57.421255Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-01T15:04:57.421525Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.65:2379"} {"level":"info","ts":"2026-04-01T15:05:11.516177Z","caller":"traceutil/trace.go:171","msg":"trace[1467047645] transaction","detail":"{read_only:false; response_revision:368; number_of_response:1; }","duration":"140.440311ms","start":"2026-04-01T15:05:11.375698Z","end":"2026-04-01T15:05:11.516138Z","steps":["trace[1467047645] 'process raft request' (duration: 140.262758ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:11.846784Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.162199ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-01T15:05:11.847302Z","caller":"traceutil/trace.go:171","msg":"trace[71736296] transaction","detail":"{read_only:false; response_revision:372; number_of_response:1; }","duration":"321.099949ms","start":"2026-04-01T15:05:11.526175Z","end":"2026-04-01T15:05:11.847274Z","steps":["trace[71736296] 'process raft request' (duration: 320.729242ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:11.84735Z","caller":"traceutil/trace.go:171","msg":"trace[160996968] transaction","detail":"{read_only:false; response_revision:371; number_of_response:1; }","duration":"326.243ms","start":"2026-04-01T15:05:11.521067Z","end":"2026-04-01T15:05:11.84731Z","steps":["trace[160996968] 'process raft request' (duration: 176.946792ms)","trace[160996968] 'compare' (duration: 148.043566ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:11.847466Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:11.52616Z","time spent":"321.22002ms","remote":"127.0.0.1:51312","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":7087,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-01T15:05:11.848198Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:11.521048Z","time spent":"326.434503ms","remote":"127.0.0.1:51382","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-01T15:05:25.394444Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"744.745483ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"warn","ts":"2026-04-01T15:05:25.394109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.582256ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:25.394577Z","caller":"traceutil/trace.go:171","msg":"trace[2008220212] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:442; }","duration":"109.117874ms","start":"2026-04-01T15:05:25.285434Z","end":"2026-04-01T15:05:25.394552Z","steps":["trace[2008220212] 'range keys from in-memory index tree' (duration: 108.555785ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:25.394591Z","caller":"traceutil/trace.go:171","msg":"trace[8360815] transaction","detail":"{read_only:false; response_revision:443; number_of_response:1; }","duration":"782.835896ms","start":"2026-04-01T15:05:24.611733Z","end":"2026-04-01T15:05:25.394569Z","steps":["trace[8360815] 'process raft request' (duration: 37.89087ms)","trace[8360815] 'compare' (duration: 744.602511ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:25.394647Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:24.61172Z","time spent":"782.904957ms","remote":"127.0.0.1:51558","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3827,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:25.805135Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.155390209s","expected-duration":"1s"} {"level":"info","ts":"2026-04-01T15:05:25.877434Z","caller":"traceutil/trace.go:171","msg":"trace[2043622827] transaction","detail":"{read_only:false; response_revision:444; number_of_response:1; }","duration":"1.264211633s","start":"2026-04-01T15:05:24.613198Z","end":"2026-04-01T15:05:25.877409Z","steps":["trace[2043622827] 'process raft request' (duration: 1.192185341s)","trace[2043622827] 'compare' (duration: 71.837949ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:25.877426Z","caller":"traceutil/trace.go:171","msg":"trace[376747030] linearizableReadLoop","detail":"{readStateIndex:461; appliedIndex:459; }","duration":"1.242980835s","start":"2026-04-01T15:05:24.634386Z","end":"2026-04-01T15:05:25.877367Z","steps":["trace[376747030] 'read index received' (duration: 15.31853ms)","trace[376747030] 'applied index is now lower than readState.Index' (duration: 1.227660585s)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:25.877583Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.243148648s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:25.877636Z","caller":"traceutil/trace.go:171","msg":"trace[2022275618] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:444; }","duration":"1.2432804s","start":"2026-04-01T15:05:24.634341Z","end":"2026-04-01T15:05:25.877621Z","steps":["trace[2022275618] 'agreement among raft nodes before linearized reading' (duration: 1.243128838s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:25.877566Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:24.613166Z","time spent":"1.264316724s","remote":"127.0.0.1:51600","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":10374,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:25.877688Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:24.634322Z","time spent":"1.243355001s","remote":"127.0.0.1:51120","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:25.878746Z","caller":"traceutil/trace.go:171","msg":"trace[1539098098] transaction","detail":"{read_only:false; response_revision:445; number_of_response:1; }","duration":"478.918226ms","start":"2026-04-01T15:05:25.399803Z","end":"2026-04-01T15:05:25.878721Z","steps":["trace[1539098098] 'process raft request' (duration: 478.467629ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:25.879023Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:25.399784Z","time spent":"479.18138ms","remote":"127.0.0.1:51592","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4177,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:25.878907Z","caller":"traceutil/trace.go:171","msg":"trace[933116828] transaction","detail":"{read_only:false; response_revision:446; number_of_response:1; }","duration":"404.574598ms","start":"2026-04-01T15:05:25.474316Z","end":"2026-04-01T15:05:25.878891Z","steps":["trace[933116828] 'process raft request' (duration: 404.08766ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:25.87948Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:25.474295Z","time spent":"405.129276ms","remote":"127.0.0.1:51200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":317275,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-01T15:05:25.888106Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.272592ms","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-01T15:05:25.888176Z","caller":"traceutil/trace.go:171","msg":"trace[1136099099] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:446; }","duration":"102.398756ms","start":"2026-04-01T15:05:25.78576Z","end":"2026-04-01T15:05:25.888159Z","steps":["trace[1136099099] 'agreement among raft nodes before linearized reading' (duration: 102.284314ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:25.888326Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"789.351614ms","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-01T15:05:25.888418Z","caller":"traceutil/trace.go:171","msg":"trace[837574919] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:446; }","duration":"789.508496ms","start":"2026-04-01T15:05:25.098895Z","end":"2026-04-01T15:05:25.888404Z","steps":["trace[837574919] 'agreement among raft nodes before linearized reading' (duration: 789.355884ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:25.88849Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:25.098869Z","time spent":"789.608277ms","remote":"127.0.0.1:51382","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-01T15:05:25.888383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.172268ms","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-01T15:05:25.888734Z","caller":"traceutil/trace.go:171","msg":"trace[516036148] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:446; }","duration":"199.696646ms","start":"2026-04-01T15:05:25.689016Z","end":"2026-04-01T15:05:25.888713Z","steps":["trace[516036148] 'agreement among raft nodes before linearized reading' (duration: 199.056916ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.135022Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073502485,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-01T15:05:28.389711Z","caller":"traceutil/trace.go:171","msg":"trace[1889584180] transaction","detail":"{read_only:false; response_revision:471; number_of_response:1; }","duration":"903.669608ms","start":"2026-04-01T15:05:27.486016Z","end":"2026-04-01T15:05:28.389686Z","steps":["trace[1889584180] 'process raft request' (duration: 903.505895ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.38989Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.485993Z","time spent":"903.78688ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6315,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.407272Z","caller":"traceutil/trace.go:171","msg":"trace[2139519384] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"917.981487ms","start":"2026-04-01T15:05:27.489258Z","end":"2026-04-01T15:05:28.40724Z","steps":["trace[2139519384] 'process raft request' (duration: 917.729113ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:28.407374Z","caller":"traceutil/trace.go:171","msg":"trace[1098130662] transaction","detail":"{read_only:false; response_revision:472; number_of_response:1; }","duration":"918.679287ms","start":"2026-04-01T15:05:27.488679Z","end":"2026-04-01T15:05:28.407358Z","steps":["trace[1098130662] 'process raft request' (duration: 913.085048ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.407421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.489229Z","time spent":"918.124009ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9490,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.407437Z","caller":"traceutil/trace.go:171","msg":"trace[719360483] transaction","detail":"{read_only:false; response_revision:475; number_of_response:1; }","duration":"906.841638ms","start":"2026-04-01T15:05:27.500565Z","end":"2026-04-01T15:05:28.407407Z","steps":["trace[719360483] 'process raft request' (duration: 906.607605ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:28.407296Z","caller":"traceutil/trace.go:171","msg":"trace[1332310574] transaction","detail":"{read_only:false; response_revision:474; number_of_response:1; }","duration":"910.555278ms","start":"2026-04-01T15:05:27.496714Z","end":"2026-04-01T15:05:28.407269Z","steps":["trace[1332310574] 'process raft request' (duration: 910.365085ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.407549Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.500555Z","time spent":"906.94593ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29801,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.40757Z","caller":"traceutil/trace.go:171","msg":"trace[239379205] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"903.870201ms","start":"2026-04-01T15:05:27.503694Z","end":"2026-04-01T15:05:28.407564Z","steps":["trace[239379205] 'process raft request' (duration: 903.547096ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.407601Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.503683Z","time spent":"903.904751ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:28.407463Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.488661Z","time spent":"918.753599ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8162,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.407917Z","caller":"traceutil/trace.go:171","msg":"trace[1048304375] transaction","detail":"{read_only:false; response_revision:478; number_of_response:1; }","duration":"904.098173ms","start":"2026-04-01T15:05:27.503804Z","end":"2026-04-01T15:05:28.407902Z","steps":["trace[1048304375] 'process raft request' (duration: 903.91836ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.407989Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.503786Z","time spent":"904.171085ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":22019,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.408014Z","caller":"traceutil/trace.go:171","msg":"trace[983830374] transaction","detail":"{read_only:false; response_revision:479; number_of_response:1; }","duration":"902.019541ms","start":"2026-04-01T15:05:27.505931Z","end":"2026-04-01T15:05:28.40795Z","steps":["trace[983830374] 'process raft request' (duration: 901.879618ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:28.408058Z","caller":"traceutil/trace.go:171","msg":"trace[1600658978] transaction","detail":"{read_only:false; response_revision:480; number_of_response:1; }","duration":"875.379912ms","start":"2026-04-01T15:05:27.532667Z","end":"2026-04-01T15:05:28.408047Z","steps":["trace[1600658978] 'process raft request' (duration: 875.191149ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.408098Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.532656Z","time spent":"875.424194ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":58271,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:28.408217Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.496698Z","time spent":"910.934004ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28462,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.4082Z","caller":"traceutil/trace.go:171","msg":"trace[122403698] transaction","detail":"{read_only:false; response_revision:477; number_of_response:1; }","duration":"903.998692ms","start":"2026-04-01T15:05:27.503778Z","end":"2026-04-01T15:05:28.407777Z","steps":["trace[122403698] 'process raft request' (duration: 903.756788ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.408135Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.505898Z","time spent":"902.170472ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29820,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:28.408646Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.50377Z","time spent":"904.746084ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28166,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.408964Z","caller":"traceutil/trace.go:171","msg":"trace[1100269385] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"849.625179ms","start":"2026-04-01T15:05:27.559317Z","end":"2026-04-01T15:05:28.408942Z","steps":["trace[1100269385] 'process raft request' (duration: 849.410155ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409054Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.559294Z","time spent":"849.7161ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:28.409147Z","caller":"traceutil/trace.go:171","msg":"trace[768740651] transaction","detail":"{read_only:false; response_revision:482; number_of_response:1; }","duration":"747.880804ms","start":"2026-04-01T15:05:27.661258Z","end":"2026-04-01T15:05:28.409138Z","steps":["trace[768740651] 'process raft request' (duration: 747.61539ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:28.409055Z","caller":"traceutil/trace.go:171","msg":"trace[184368872] linearizableReadLoop","detail":"{readStateIndex:500; appliedIndex:488; }","duration":"774.560203ms","start":"2026-04-01T15:05:27.634463Z","end":"2026-04-01T15:05:28.409023Z","steps":["trace[184368872] 'read index received' (duration: 755.046421ms)","trace[184368872] 'applied index is now lower than readState.Index' (duration: 19.511652ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:28.409197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.661229Z","time spent":"747.947585ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":149907,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:28.409294Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"774.820637ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:28.40934Z","caller":"traceutil/trace.go:171","msg":"trace[1476329489] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:484; }","duration":"774.911989ms","start":"2026-04-01T15:05:27.634414Z","end":"2026-04-01T15:05:28.409326Z","steps":["trace[1476329489] 'agreement among raft nodes before linearized reading' (duration: 774.807867ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409354Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.751607ms","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-01T15:05:28.409373Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.634392Z","time spent":"774.973239ms","remote":"127.0.0.1:51120","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:28.409396Z","caller":"traceutil/trace.go:171","msg":"trace[1965086252] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:484; }","duration":"502.820118ms","start":"2026-04-01T15:05:27.906565Z","end":"2026-04-01T15:05:28.409385Z","steps":["trace[1965086252] 'agreement among raft nodes before linearized reading' (duration: 502.745237ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409429Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.906548Z","time spent":"502.873649ms","remote":"127.0.0.1:51382","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-01T15:05:28.409554Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.472102ms","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-01T15:05:28.409593Z","caller":"traceutil/trace.go:171","msg":"trace[1499309579] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:484; }","duration":"502.543752ms","start":"2026-04-01T15:05:27.90704Z","end":"2026-04-01T15:05:28.409584Z","steps":["trace[1499309579] 'agreement among raft nodes before linearized reading' (duration: 502.475321ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409621Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.907016Z","time spent":"502.597374ms","remote":"127.0.0.1:51382","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-01T15:05:28.409637Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.995591ms","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-01T15:05:28.409664Z","caller":"traceutil/trace.go:171","msg":"trace[1466356282] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:484; }","duration":"503.039103ms","start":"2026-04-01T15:05:27.906617Z","end":"2026-04-01T15:05:28.409656Z","steps":["trace[1466356282] 'agreement among raft nodes before linearized reading' (duration: 502.93548ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409698Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.906612Z","time spent":"503.079543ms","remote":"127.0.0.1:51382","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-01T15:05:28.409815Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"437.152695ms","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-01T15:05:28.409868Z","caller":"traceutil/trace.go:171","msg":"trace[1033742648] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:484; }","duration":"437.256946ms","start":"2026-04-01T15:05:27.972598Z","end":"2026-04-01T15:05:28.409855Z","steps":["trace[1033742648] 'agreement among raft nodes before linearized reading' (duration: 437.018351ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:28.409909Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:27.972567Z","time spent":"437.332927ms","remote":"127.0.0.1:51382","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-01T15:05:29.464747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"680.608344ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-01T15:05:29.46503Z","caller":"traceutil/trace.go:171","msg":"trace[1040113821] transaction","detail":"{read_only:false; response_revision:522; number_of_response:1; }","duration":"752.636585ms","start":"2026-04-01T15:05:28.712353Z","end":"2026-04-01T15:05:29.464989Z","steps":["trace[1040113821] 'process raft request' (duration: 71.698595ms)","trace[1040113821] 'compare' (duration: 680.466582ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:29.465136Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:28.712292Z","time spent":"752.795837ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":80688,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-01T15:05:30.055737Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.2715553s","expected-duration":"1s"} {"level":"info","ts":"2026-04-01T15:05:30.09529Z","caller":"traceutil/trace.go:171","msg":"trace[157155464] transaction","detail":"{read_only:false; response_revision:524; number_of_response:1; }","duration":"1.342344643s","start":"2026-04-01T15:05:28.75292Z","end":"2026-04-01T15:05:30.095265Z","steps":["trace[157155464] 'process raft request' (duration: 1.342047088s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:30.095421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:28.752895Z","time spent":"1.342448774s","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":151212,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:30.095515Z","caller":"traceutil/trace.go:171","msg":"trace[644734132] transaction","detail":"{read_only:false; response_revision:523; number_of_response:1; }","duration":"1.378229727s","start":"2026-04-01T15:05:28.717254Z","end":"2026-04-01T15:05:30.095484Z","steps":["trace[644734132] 'process raft request' (duration: 1.338799714s)","trace[644734132] 'compare' (duration: 38.324935ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:30.095566Z","caller":"traceutil/trace.go:171","msg":"trace[1298265345] linearizableReadLoop","detail":"{readStateIndex:545; appliedIndex:543; }","duration":"461.901174ms","start":"2026-04-01T15:05:29.633654Z","end":"2026-04-01T15:05:30.095555Z","steps":["trace[1298265345] 'read index received' (duration: 422.366359ms)","trace[1298265345] 'applied index is now lower than readState.Index' (duration: 39.533765ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:30.09563Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:28.717233Z","time spent":"1.378340008s","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":73770,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:30.095689Z","caller":"traceutil/trace.go:171","msg":"trace[1186302987] transaction","detail":"{read_only:false; response_revision:525; number_of_response:1; }","duration":"180.05508ms","start":"2026-04-01T15:05:29.915625Z","end":"2026-04-01T15:05:30.09568Z","steps":["trace[1186302987] 'process raft request' (duration: 179.591072ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:30.095909Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"462.259229ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:30.09594Z","caller":"traceutil/trace.go:171","msg":"trace[1636260982] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:525; }","duration":"462.3224ms","start":"2026-04-01T15:05:29.633609Z","end":"2026-04-01T15:05:30.095931Z","steps":["trace[1636260982] 'agreement among raft nodes before linearized reading' (duration: 461.981315ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:30.095966Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:29.633559Z","time spent":"462.401281ms","remote":"127.0.0.1:51120","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:30.783085Z","caller":"traceutil/trace.go:171","msg":"trace[76761277] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"282.398227ms","start":"2026-04-01T15:05:30.500662Z","end":"2026-04-01T15:05:30.78306Z","steps":["trace[76761277] 'process raft request' (duration: 274.448201ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:30.783091Z","caller":"traceutil/trace.go:171","msg":"trace[1501045909] linearizableReadLoop","detail":"{readStateIndex:568; appliedIndex:567; }","duration":"219.388313ms","start":"2026-04-01T15:05:30.563662Z","end":"2026-04-01T15:05:30.78305Z","steps":["trace[1501045909] 'read index received' (duration: 211.408426ms)","trace[1501045909] 'applied index is now lower than readState.Index' (duration: 7.978757ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:30.783273Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"219.598546ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.65\" ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-04-01T15:05:30.783383Z","caller":"traceutil/trace.go:171","msg":"trace[1881154027] range","detail":"{range_begin:/registry/masterleases/199.204.45.65; range_end:; response_count:1; response_revision:547; }","duration":"219.747408ms","start":"2026-04-01T15:05:30.563615Z","end":"2026-04-01T15:05:30.783362Z","steps":["trace[1881154027] 'agreement among raft nodes before linearized reading' (duration: 219.555625ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:30.784168Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.480014ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:30.784207Z","caller":"traceutil/trace.go:171","msg":"trace[1098934263] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:548; }","duration":"150.556375ms","start":"2026-04-01T15:05:30.633639Z","end":"2026-04-01T15:05:30.784196Z","steps":["trace[1098934263] 'agreement among raft nodes before linearized reading' (duration: 150.477464ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:30.784328Z","caller":"traceutil/trace.go:171","msg":"trace[267050315] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"197.448276ms","start":"2026-04-01T15:05:30.586874Z","end":"2026-04-01T15:05:30.784322Z","steps":["trace[267050315] 'process raft request' (duration: 197.004868ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:35.349407Z","caller":"traceutil/trace.go:171","msg":"trace[1587100498] transaction","detail":"{read_only:false; response_revision:580; number_of_response:1; }","duration":"138.026988ms","start":"2026-04-01T15:05:35.211355Z","end":"2026-04-01T15:05:35.349382Z","steps":["trace[1587100498] 'process raft request' (duration: 137.270256ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.588637Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"927.47828ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-01T15:05:36.589088Z","caller":"traceutil/trace.go:171","msg":"trace[2099747718] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"1.120310488s","start":"2026-04-01T15:05:35.468727Z","end":"2026-04-01T15:05:36.589037Z","steps":["trace[2099747718] 'process raft request' (duration: 192.345842ms)","trace[2099747718] 'compare' (duration: 926.88943ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:36.589119Z","caller":"traceutil/trace.go:171","msg":"trace[1412391011] linearizableReadLoop","detail":"{readStateIndex:604; appliedIndex:603; }","duration":"956.20915ms","start":"2026-04-01T15:05:35.632829Z","end":"2026-04-01T15:05:36.589038Z","steps":["trace[1412391011] 'read index received' (duration: 28.186793ms)","trace[1412391011] 'applied index is now lower than readState.Index' (duration: 928.016577ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:36.589305Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.468712Z","time spent":"1.12046153s","remote":"127.0.0.1:51312","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17130,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-01T15:05:36.731306Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.09845944s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.731374Z","caller":"traceutil/trace.go:171","msg":"trace[977060136] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:582; }","duration":"1.098575533s","start":"2026-04-01T15:05:35.632781Z","end":"2026-04-01T15:05:36.731356Z","steps":["trace[977060136] 'agreement among raft nodes before linearized reading' (duration: 956.369122ms)","trace[977060136] 'range keys from in-memory index tree' (duration: 142.094578ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:36.73137Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.610976ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"warn","ts":"2026-04-01T15:05:36.731417Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.632761Z","time spent":"1.098647043s","remote":"127.0.0.1:51120","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:36.732537Z","caller":"traceutil/trace.go:171","msg":"trace[1923022049] linearizableReadLoop","detail":"{readStateIndex:606; appliedIndex:604; }","duration":"143.317556ms","start":"2026-04-01T15:05:36.589192Z","end":"2026-04-01T15:05:36.73251Z","steps":["trace[1923022049] 'read index received' (duration: 50.261µs)","trace[1923022049] 'applied index is now lower than readState.Index' (duration: 143.266145ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:36.732693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"739.944461ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.732816Z","caller":"traceutil/trace.go:171","msg":"trace[62303314] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:583; }","duration":"740.068332ms","start":"2026-04-01T15:05:35.992656Z","end":"2026-04-01T15:05:36.732725Z","steps":["trace[62303314] 'agreement among raft nodes before linearized reading' (duration: 739.939621ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.73284Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"344.702849ms","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-01T15:05:36.733002Z","caller":"traceutil/trace.go:171","msg":"trace[439899692] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:583; }","duration":"344.898492ms","start":"2026-04-01T15:05:36.388078Z","end":"2026-04-01T15:05:36.732976Z","steps":["trace[439899692] 'agreement among raft nodes before linearized reading' (duration: 344.619308ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.733036Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"345.008374ms","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":"warn","ts":"2026-04-01T15:05:36.733113Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.388073Z","time spent":"345.023824ms","remote":"127.0.0.1:49794","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:05:36.73316Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.004826ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.73326Z","caller":"traceutil/trace.go:171","msg":"trace[1819951730] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"294.126218ms","start":"2026-04-01T15:05:36.439115Z","end":"2026-04-01T15:05:36.733242Z","steps":["trace[1819951730] 'agreement among raft nodes before linearized reading' (duration: 293.955425ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.733262Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"383.170996ms","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-01T15:05:36.733326Z","caller":"traceutil/trace.go:171","msg":"trace[1736791261] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:583; }","duration":"383.264197ms","start":"2026-04-01T15:05:36.350051Z","end":"2026-04-01T15:05:36.733315Z","steps":["trace[1736791261] 'agreement among raft nodes before linearized reading' (duration: 383.179736ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.733394Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.350035Z","time spent":"383.346938ms","remote":"127.0.0.1:49778","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-01T15:05:36.733601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.559635ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.733645Z","caller":"traceutil/trace.go:171","msg":"trace[1820756786] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"294.627396ms","start":"2026-04-01T15:05:36.439008Z","end":"2026-04-01T15:05:36.733635Z","steps":["trace[1820756786] 'agreement among raft nodes before linearized reading' (duration: 294.558235ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.733615Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"316.391447ms","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-01T15:05:36.733753Z","caller":"traceutil/trace.go:171","msg":"trace[588479647] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:583; }","duration":"316.55259ms","start":"2026-04-01T15:05:36.417184Z","end":"2026-04-01T15:05:36.733737Z","steps":["trace[588479647] 'agreement among raft nodes before linearized reading' (duration: 316.380658ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.73384Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.417174Z","time spent":"316.649551ms","remote":"127.0.0.1:49794","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:500 "} {"level":"warn","ts":"2026-04-01T15:05:36.733846Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.291964ms","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-01T15:05:36.733948Z","caller":"traceutil/trace.go:171","msg":"trace[638188480] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:583; }","duration":"384.436556ms","start":"2026-04-01T15:05:36.349498Z","end":"2026-04-01T15:05:36.733935Z","steps":["trace[638188480] 'agreement among raft nodes before linearized reading' (duration: 384.311584ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.734047Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.349467Z","time spent":"384.517277ms","remote":"127.0.0.1:49778","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-01T15:05:36.734154Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.192945ms","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":"warn","ts":"2026-04-01T15:05:36.734213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.780431ms","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-01T15:05:36.734221Z","caller":"traceutil/trace.go:171","msg":"trace[1170012048] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:583; }","duration":"318.283836ms","start":"2026-04-01T15:05:36.415927Z","end":"2026-04-01T15:05:36.734211Z","steps":["trace[1170012048] 'agreement among raft nodes before linearized reading' (duration: 318.192495ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.734303Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"483.617498ms","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-01T15:05:36.734334Z","caller":"traceutil/trace.go:171","msg":"trace[2133912158] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:583; }","duration":"483.647579ms","start":"2026-04-01T15:05:36.250678Z","end":"2026-04-01T15:05:36.734326Z","steps":["trace[2133912158] 'agreement among raft nodes before linearized reading' (duration: 483.607108ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.734361Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.250657Z","time spent":"483.688929ms","remote":"127.0.0.1:49766","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-01T15:05:36.734367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"634.022564ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734418Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.41591Z","time spent":"318.405298ms","remote":"127.0.0.1:49808","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-01T15:05:36.734518Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"634.601032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734528Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"484.296559ms","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":"warn","ts":"2026-04-01T15:05:36.734523Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.710221ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.735557Z","caller":"traceutil/trace.go:171","msg":"trace[1006574042] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:583; }","duration":"174.823327ms","start":"2026-04-01T15:05:36.560717Z","end":"2026-04-01T15:05:36.73554Z","steps":["trace[1006574042] 'agreement among raft nodes before linearized reading' (duration: 173.67715ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.734437Z","caller":"traceutil/trace.go:171","msg":"trace[531839131] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:583; }","duration":"634.139355ms","start":"2026-04-01T15:05:36.100285Z","end":"2026-04-01T15:05:36.734425Z","steps":["trace[531839131] 'agreement among raft nodes before linearized reading' (duration: 633.994883ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.734266Z","caller":"traceutil/trace.go:171","msg":"trace[1165975020] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:583; }","duration":"384.898883ms","start":"2026-04-01T15:05:36.349347Z","end":"2026-04-01T15:05:36.734246Z","steps":["trace[1165975020] 'agreement among raft nodes before linearized reading' (duration: 384.842752ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.734141Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.074498ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.732902Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.218309ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.734573Z","caller":"traceutil/trace.go:171","msg":"trace[1500118385] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:583; }","duration":"484.35ms","start":"2026-04-01T15:05:36.250213Z","end":"2026-04-01T15:05:36.734563Z","steps":["trace[1500118385] 'agreement among raft nodes before linearized reading' (duration: 484.285179ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.733122Z","caller":"traceutil/trace.go:171","msg":"trace[956523531] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:583; }","duration":"345.103765ms","start":"2026-04-01T15:05:36.387988Z","end":"2026-04-01T15:05:36.733092Z","steps":["trace[956523531] 'agreement among raft nodes before linearized reading' (duration: 344.984853ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.734559Z","caller":"traceutil/trace.go:171","msg":"trace[1148954313] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:583; }","duration":"634.681413ms","start":"2026-04-01T15:05:36.099864Z","end":"2026-04-01T15:05:36.734546Z","steps":["trace[1148954313] 'agreement among raft nodes before linearized reading' (duration: 634.598612ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.734619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"484.646735ms","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":"warn","ts":"2026-04-01T15:05:36.734656Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"536.446214ms","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":"warn","ts":"2026-04-01T15:05:36.734689Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"537.348268ms","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":"warn","ts":"2026-04-01T15:05:36.734663Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"634.804595ms","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":"warn","ts":"2026-04-01T15:05:36.734693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.745403ms","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":"warn","ts":"2026-04-01T15:05:36.732942Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.992641Z","time spent":"740.282985ms","remote":"127.0.0.1:49688","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-04-01T15:05:36.734721Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"537.631543ms","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":"warn","ts":"2026-04-01T15:05:36.734734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"653.242157ms","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":"warn","ts":"2026-04-01T15:05:36.734761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"573.405078ms","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":"warn","ts":"2026-04-01T15:05:36.734796Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"573.945886ms","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":"warn","ts":"2026-04-01T15:05:36.734804Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"653.591412ms","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":"warn","ts":"2026-04-01T15:05:36.734829Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.316712ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734847Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"653.847536ms","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":"warn","ts":"2026-04-01T15:05:36.73486Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.774988ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"681.507899ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734922Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"682.24295ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.734958Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"682.290601ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.735042Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"741.971661ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.735043Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.480679ms","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-01T15:05:36.735079Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"742.068443ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:36.735103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.519507ms","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-01T15:05:36.735124Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.454482ms","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":"warn","ts":"2026-04-01T15:05:36.735149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.699579ms","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":"warn","ts":"2026-04-01T15:05:36.735172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.278999ms","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":"warn","ts":"2026-04-01T15:05:36.738534Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.349325Z","time spent":"389.203078ms","remote":"127.0.0.1:49778","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-01T15:05:36.73859Z","caller":"traceutil/trace.go:171","msg":"trace[1612917164] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:583; }","duration":"541.519692ms","start":"2026-04-01T15:05:36.19705Z","end":"2026-04-01T15:05:36.73857Z","steps":["trace[1612917164] 'agreement among raft nodes before linearized reading' (duration: 537.653203ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738627Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.197035Z","time spent":"541.578783ms","remote":"127.0.0.1:49760","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-01T15:05:36.738628Z","caller":"traceutil/trace.go:171","msg":"trace[610584730] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:583; }","duration":"612.579086ms","start":"2026-04-01T15:05:36.126041Z","end":"2026-04-01T15:05:36.73862Z","steps":["trace[610584730] 'agreement among raft nodes before linearized reading' (duration: 608.059427ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.126029Z","time spent":"612.620267ms","remote":"127.0.0.1:49740","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/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true "} {"level":"info","ts":"2026-04-01T15:05:36.738632Z","caller":"traceutil/trace.go:171","msg":"trace[1160737331] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:583; }","duration":"272.723952ms","start":"2026-04-01T15:05:36.465869Z","end":"2026-04-01T15:05:36.738593Z","steps":["trace[1160737331] 'agreement among raft nodes before linearized reading' (duration: 269.28323ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.738747Z","caller":"traceutil/trace.go:171","msg":"trace[106224303] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"300.093728ms","start":"2026-04-01T15:05:36.438645Z","end":"2026-04-01T15:05:36.738739Z","steps":["trace[106224303] 'agreement among raft nodes before linearized reading' (duration: 294.199898ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738775Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.438636Z","time spent":"300.130429ms","remote":"127.0.0.1:49816","response type":"/etcdserverpb.KV/Range","request count":0,"request size":131,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:10000 "} {"level":"info","ts":"2026-04-01T15:05:36.738768Z","caller":"traceutil/trace.go:171","msg":"trace[1659431054] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:583; }","duration":"657.286828ms","start":"2026-04-01T15:05:36.081473Z","end":"2026-04-01T15:05:36.73876Z","steps":["trace[1659431054] 'agreement among raft nodes before linearized reading' (duration: 653.235176ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738811Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.081467Z","time spent":"657.333789ms","remote":"127.0.0.1:49716","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 "} {"level":"warn","ts":"2026-04-01T15:05:36.738845Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.25021Z","time spent":"488.628835ms","remote":"127.0.0.1:49766","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-01T15:05:36.738925Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.387973Z","time spent":"350.945794ms","remote":"127.0.0.1:49794","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":"info","ts":"2026-04-01T15:05:36.738944Z","caller":"traceutil/trace.go:171","msg":"trace[259586714] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:583; }","duration":"577.655143ms","start":"2026-04-01T15:05:36.16128Z","end":"2026-04-01T15:05:36.738935Z","steps":["trace[259586714] 'agreement among raft nodes before linearized reading' (duration: 573.461599ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738997Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.161263Z","time spent":"577.720774ms","remote":"127.0.0.1:49750","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-01T15:05:36.739004Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.099857Z","time spent":"639.139372ms","remote":"127.0.0.1:49732","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 "} {"level":"info","ts":"2026-04-01T15:05:36.739093Z","caller":"traceutil/trace.go:171","msg":"trace[354448496] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:583; }","duration":"489.140524ms","start":"2026-04-01T15:05:36.249944Z","end":"2026-04-01T15:05:36.739085Z","steps":["trace[354448496] 'agreement among raft nodes before linearized reading' (duration: 484.649725ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.739124Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.249925Z","time spent":"489.190714ms","remote":"127.0.0.1:49766","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":"info","ts":"2026-04-01T15:05:36.739124Z","caller":"traceutil/trace.go:171","msg":"trace[1532568960] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:583; }","duration":"578.283873ms","start":"2026-04-01T15:05:36.160832Z","end":"2026-04-01T15:05:36.739116Z","steps":["trace[1532568960] 'agreement among raft nodes before linearized reading' (duration: 573.945846ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.739169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.160825Z","time spent":"578.335894ms","remote":"127.0.0.1:49750","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-01T15:05:36.739194Z","caller":"traceutil/trace.go:171","msg":"trace[894282424] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:583; }","duration":"540.991604ms","start":"2026-04-01T15:05:36.198196Z","end":"2026-04-01T15:05:36.739187Z","steps":["trace[894282424] 'agreement among raft nodes before linearized reading' (duration: 536.441024ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.739221Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.198192Z","time spent":"541.021845ms","remote":"127.0.0.1:49760","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":"info","ts":"2026-04-01T15:05:36.739105Z","caller":"traceutil/trace.go:171","msg":"trace[2085591579] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:583; }","duration":"658.109321ms","start":"2026-04-01T15:05:36.080981Z","end":"2026-04-01T15:05:36.73909Z","steps":["trace[2085591579] 'agreement among raft nodes before linearized reading' (duration: 653.843676ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.739274Z","caller":"traceutil/trace.go:171","msg":"trace[1967278626] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:583; }","duration":"658.098501ms","start":"2026-04-01T15:05:36.081167Z","end":"2026-04-01T15:05:36.739265Z","steps":["trace[1967278626] 'agreement among raft nodes before linearized reading' (duration: 653.586841ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.739295Z","caller":"traceutil/trace.go:171","msg":"trace[1946869117] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:583; }","duration":"541.961929ms","start":"2026-04-01T15:05:36.197326Z","end":"2026-04-01T15:05:36.739288Z","steps":["trace[1946869117] 'agreement among raft nodes before linearized reading' (duration: 537.344218ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.739321Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.197321Z","time spent":"541.992479ms","remote":"127.0.0.1:49760","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-01T15:05:36.739315Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.081143Z","time spent":"658.149282ms","remote":"127.0.0.1:49716","response type":"/etcdserverpb.KV/Range","request count":0,"request size":88,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:05:36.739367Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.080974Z","time spent":"658.311094ms","remote":"127.0.0.1:49716","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 "} {"level":"warn","ts":"2026-04-01T15:05:36.735186Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"270.03362ms","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-01T15:05:36.739428Z","caller":"traceutil/trace.go:171","msg":"trace[1843724538] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:583; }","duration":"274.298635ms","start":"2026-04-01T15:05:36.465125Z","end":"2026-04-01T15:05:36.739423Z","steps":["trace[1843724538] 'agreement among raft nodes before linearized reading' (duration: 270.001719ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.472575ms","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-01T15:05:36.739631Z","caller":"traceutil/trace.go:171","msg":"trace[1826185956] 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:583; }","duration":"152.926813ms","start":"2026-04-01T15:05:36.586698Z","end":"2026-04-01T15:05:36.739624Z","steps":["trace[1826185956] 'agreement among raft nodes before linearized reading' (duration: 148.519146ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.739611Z","caller":"traceutil/trace.go:171","msg":"trace[1426393713] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:583; }","duration":"613.5166ms","start":"2026-04-01T15:05:36.126078Z","end":"2026-04-01T15:05:36.739595Z","steps":["trace[1426393713] 'agreement among raft nodes before linearized reading' (duration: 608.766888ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.739734Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.126009Z","time spent":"613.706803ms","remote":"127.0.0.1:49740","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/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-01T15:05:36.735247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.676975ms","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-01T15:05:36.739813Z","caller":"traceutil/trace.go:171","msg":"trace[892701091] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:583; }","duration":"194.267714ms","start":"2026-04-01T15:05:36.54554Z","end":"2026-04-01T15:05:36.739808Z","steps":["trace[892701091] 'agreement among raft nodes before linearized reading' (duration: 189.682995ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.73986Z","caller":"traceutil/trace.go:171","msg":"trace[152364082] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:583; }","duration":"273.29573ms","start":"2026-04-01T15:05:36.466553Z","end":"2026-04-01T15:05:36.739836Z","steps":["trace[152364082] 'agreement among raft nodes before linearized reading' (duration: 268.523128ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.739984Z","caller":"traceutil/trace.go:171","msg":"trace[1505201526] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"686.599696ms","start":"2026-04-01T15:05:36.05336Z","end":"2026-04-01T15:05:36.73996Z","steps":["trace[1505201526] 'agreement among raft nodes before linearized reading' (duration: 681.504159ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735285Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.221382ms","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":"warn","ts":"2026-04-01T15:05:36.740016Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.053357Z","time spent":"686.648386ms","remote":"127.0.0.1:49702","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 "} {"level":"info","ts":"2026-04-01T15:05:36.740046Z","caller":"traceutil/trace.go:171","msg":"trace[807563541] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:583; }","duration":"231.004345ms","start":"2026-04-01T15:05:36.509035Z","end":"2026-04-01T15:05:36.740039Z","steps":["trace[807563541] 'agreement among raft nodes before linearized reading' (duration: 226.231402ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.740061Z","caller":"traceutil/trace.go:171","msg":"trace[56716082] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:583; }","duration":"274.350106ms","start":"2026-04-01T15:05:36.465646Z","end":"2026-04-01T15:05:36.739996Z","steps":["trace[56716082] 'agreement among raft nodes before linearized reading' (duration: 269.442352ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.740157Z","caller":"traceutil/trace.go:171","msg":"trace[460312466] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"687.503139ms","start":"2026-04-01T15:05:36.052644Z","end":"2026-04-01T15:05:36.740148Z","steps":["trace[460312466] 'agreement among raft nodes before linearized reading' (duration: 682.25721ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.740186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.052633Z","time spent":"687.54419ms","remote":"127.0.0.1:49702","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:05:36.735298Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.603605ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.740219Z","caller":"traceutil/trace.go:171","msg":"trace[75746809] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:583; }","duration":"179.562929ms","start":"2026-04-01T15:05:36.56065Z","end":"2026-04-01T15:05:36.740212Z","steps":["trace[75746809] 'agreement among raft nodes before linearized reading' (duration: 174.619294ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.740284Z","caller":"traceutil/trace.go:171","msg":"trace[1874777301] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:583; }","duration":"687.615761ms","start":"2026-04-01T15:05:36.05266Z","end":"2026-04-01T15:05:36.740276Z","steps":["trace[1874777301] 'agreement among raft nodes before linearized reading' (duration: 682.279201ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.740333Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.052628Z","time spent":"687.694842ms","remote":"127.0.0.1:49702","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-04-01T15:05:36.73531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"270.321704ms","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-01T15:05:36.740363Z","caller":"traceutil/trace.go:171","msg":"trace[59452755] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:583; }","duration":"275.389051ms","start":"2026-04-01T15:05:36.464967Z","end":"2026-04-01T15:05:36.740356Z","steps":["trace[59452755] 'agreement among raft nodes before linearized reading' (duration: 270.236193ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.740419Z","caller":"traceutil/trace.go:171","msg":"trace[499344614] 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:583; }","duration":"153.992339ms","start":"2026-04-01T15:05:36.586415Z","end":"2026-04-01T15:05:36.740407Z","steps":["trace[499344614] 'agreement among raft nodes before linearized reading' (duration: 148.694848ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735323Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.796066ms","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-01T15:05:36.740476Z","caller":"traceutil/trace.go:171","msg":"trace[149661055] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:583; }","duration":"281.939582ms","start":"2026-04-01T15:05:36.45853Z","end":"2026-04-01T15:05:36.740469Z","steps":["trace[149661055] 'agreement among raft nodes before linearized reading' (duration: 276.395897ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.740495Z","caller":"traceutil/trace.go:171","msg":"trace[1642305162] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:583; }","duration":"194.967985ms","start":"2026-04-01T15:05:36.54552Z","end":"2026-04-01T15:05:36.740488Z","steps":["trace[1642305162] 'agreement among raft nodes before linearized reading' (duration: 189.784636ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.74057Z","caller":"traceutil/trace.go:171","msg":"trace[85760989] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:583; }","duration":"747.569066ms","start":"2026-04-01T15:05:35.992993Z","end":"2026-04-01T15:05:36.740562Z","steps":["trace[85760989] 'agreement among raft nodes before linearized reading' (duration: 742.068372ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.340338ms","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":"warn","ts":"2026-04-01T15:05:36.740598Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.992988Z","time spent":"747.601127ms","remote":"127.0.0.1:49688","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:500 "} {"level":"info","ts":"2026-04-01T15:05:36.740626Z","caller":"traceutil/trace.go:171","msg":"trace[2092716614] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:583; }","duration":"194.66477ms","start":"2026-04-01T15:05:36.545953Z","end":"2026-04-01T15:05:36.740618Z","steps":["trace[2092716614] 'agreement among raft nodes before linearized reading' (duration: 189.362419ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.735198Z","caller":"traceutil/trace.go:171","msg":"trace[707714721] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"874.578116ms","start":"2026-04-01T15:05:35.860607Z","end":"2026-04-01T15:05:36.735185Z","steps":["trace[707714721] 'process raft request' (duration: 871.183724ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735368Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.987434ms","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-01T15:05:36.740777Z","caller":"traceutil/trace.go:171","msg":"trace[875444783] 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:583; }","duration":"154.426786ms","start":"2026-04-01T15:05:36.586344Z","end":"2026-04-01T15:05:36.740771Z","steps":["trace[875444783] 'agreement among raft nodes before linearized reading' (duration: 148.993993ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.822892ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:36.740923Z","caller":"traceutil/trace.go:171","msg":"trace[2040032018] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:583; }","duration":"179.402988ms","start":"2026-04-01T15:05:36.561514Z","end":"2026-04-01T15:05:36.740917Z","steps":["trace[2040032018] 'agreement among raft nodes before linearized reading' (duration: 173.833253ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.740887Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.860575Z","time spent":"880.187141ms","remote":"127.0.0.1:51200","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036289,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:36.740437Z","caller":"traceutil/trace.go:171","msg":"trace[1161407811] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:583; }","duration":"747.361513ms","start":"2026-04-01T15:05:35.993061Z","end":"2026-04-01T15:05:36.740423Z","steps":["trace[1161407811] 'agreement among raft nodes before linearized reading' (duration: 741.961491ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.741095Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:35.993016Z","time spent":"748.064204ms","remote":"127.0.0.1:49688","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" count_only:true "} {"level":"info","ts":"2026-04-01T15:05:36.739387Z","caller":"traceutil/trace.go:171","msg":"trace[624899033] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:583; }","duration":"639.566178ms","start":"2026-04-01T15:05:36.099815Z","end":"2026-04-01T15:05:36.739381Z","steps":["trace[624899033] 'agreement among raft nodes before linearized reading' (duration: 634.816385ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.738411Z","caller":"traceutil/trace.go:171","msg":"trace[1556748215] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:583; }","duration":"611.926177ms","start":"2026-04-01T15:05:36.126472Z","end":"2026-04-01T15:05:36.738398Z","steps":["trace[1556748215] 'agreement among raft nodes before linearized reading' (duration: 608.337923ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.738511Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.100274Z","time spent":"638.225808ms","remote":"127.0.0.1:49732","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 "} {"level":"warn","ts":"2026-04-01T15:05:36.735466Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.325024ms","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-01T15:05:36.74365Z","caller":"traceutil/trace.go:171","msg":"trace[1568657070] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:583; }","duration":"276.518889ms","start":"2026-04-01T15:05:36.467121Z","end":"2026-04-01T15:05:36.74364Z","steps":["trace[1568657070] 'agreement among raft nodes before linearized reading' (duration: 265.603272ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.735383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.320053ms","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-01T15:05:36.743781Z","caller":"traceutil/trace.go:171","msg":"trace[2021695676] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:583; }","duration":"234.753712ms","start":"2026-04-01T15:05:36.509015Z","end":"2026-04-01T15:05:36.743769Z","steps":["trace[2021695676] 'agreement among raft nodes before linearized reading' (duration: 226.349034ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:36.73841Z","caller":"traceutil/trace.go:171","msg":"trace[1646805787] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:583; }","duration":"322.46305ms","start":"2026-04-01T15:05:36.415934Z","end":"2026-04-01T15:05:36.738397Z","steps":["trace[1646805787] 'agreement among raft nodes before linearized reading' (duration: 318.726013ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:36.743892Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.415928Z","time spent":"327.954144ms","remote":"127.0.0.1:49808","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:05:36.744007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.099793Z","time spent":"644.207198ms","remote":"127.0.0.1:49732","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-01T15:05:36.744071Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.12646Z","time spent":"617.601613ms","remote":"127.0.0.1:49740","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/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:500 "} {"level":"warn","ts":"2026-04-01T15:05:37.37174Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073502679,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-01T15:05:37.872511Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073502679,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-01T15:05:38.060636Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.314202678s","expected-duration":"1s"} {"level":"warn","ts":"2026-04-01T15:05:39.109308Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.048304213s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-01T15:05:39.109524Z","caller":"traceutil/trace.go:171","msg":"trace[340664502] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"2.361737371s","start":"2026-04-01T15:05:36.747768Z","end":"2026-04-01T15:05:39.109506Z","steps":["trace[340664502] 'process raft request' (duration: 2.361643349s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.109595Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.747756Z","time spent":"2.361808342s","remote":"127.0.0.1:51382","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-01T15:05:39.109786Z","caller":"traceutil/trace.go:171","msg":"trace[1325053068] transaction","detail":"{read_only:false; response_revision:584; number_of_response:1; }","duration":"2.363410416s","start":"2026-04-01T15:05:36.746364Z","end":"2026-04-01T15:05:39.109774Z","steps":["trace[1325053068] 'process raft request' (duration: 1.314563524s)","trace[1325053068] 'compare' (duration: 1.048182132s)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:39.109844Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.746354Z","time spent":"2.363462377s","remote":"127.0.0.1:51382","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-01T15:05:39.110904Z","caller":"traceutil/trace.go:171","msg":"trace[418391439] transaction","detail":"{read_only:false; response_revision:586; number_of_response:1; }","duration":"2.36300855s","start":"2026-04-01T15:05:36.747882Z","end":"2026-04-01T15:05:39.11089Z","steps":["trace[418391439] 'process raft request' (duration: 2.361575899s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.110984Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.747869Z","time spent":"2.363075901s","remote":"127.0.0.1:51382","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-01T15:05:39.111444Z","caller":"traceutil/trace.go:171","msg":"trace[768528] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"2.36299545s","start":"2026-04-01T15:05:36.748434Z","end":"2026-04-01T15:05:39.111429Z","steps":["trace[768528] 'process raft request' (duration: 2.362389671s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.111535Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.748425Z","time spent":"2.363057811s","remote":"127.0.0.1:51382","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-01T15:05:39.111638Z","caller":"traceutil/trace.go:171","msg":"trace[1288839399] linearizableReadLoop","detail":"{readStateIndex:611; appliedIndex:606; }","duration":"2.240317827s","start":"2026-04-01T15:05:36.871291Z","end":"2026-04-01T15:05:39.111609Z","steps":["trace[1288839399] 'read index received' (duration: 1.189583018s)","trace[1288839399] 'applied index is now lower than readState.Index' (duration: 1.050733909s)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:39.1119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.004568508s","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-01T15:05:39.111943Z","caller":"traceutil/trace.go:171","msg":"trace[752567750] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:588; }","duration":"2.004628639s","start":"2026-04-01T15:05:37.107302Z","end":"2026-04-01T15:05:39.111931Z","steps":["trace[752567750] 'agreement among raft nodes before linearized reading' (duration: 2.004529868s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.11195Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.022767184s","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-01T15:05:39.111978Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.107259Z","time spent":"2.004709181s","remote":"127.0.0.1:49910","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":"info","ts":"2026-04-01T15:05:39.111983Z","caller":"traceutil/trace.go:171","msg":"trace[1185031445] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:588; }","duration":"2.022843866s","start":"2026-04-01T15:05:37.089128Z","end":"2026-04-01T15:05:39.111972Z","steps":["trace[1185031445] 'agreement among raft nodes before linearized reading' (duration: 2.022799815s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.089097Z","time spent":"2.022911496s","remote":"127.0.0.1:49904","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-01T15:05:39.112052Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.240695733s","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-01T15:05:39.11217Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"479.081881ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:39.112186Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.04885271s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:39.1122Z","caller":"traceutil/trace.go:171","msg":"trace[571915199] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:588; }","duration":"479.158253ms","start":"2026-04-01T15:05:38.633033Z","end":"2026-04-01T15:05:39.112191Z","steps":["trace[571915199] 'agreement among raft nodes before linearized reading' (duration: 479.114312ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112184Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.04881455s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:39.112227Z","caller":"traceutil/trace.go:171","msg":"trace[2052839079] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:588; }","duration":"2.048921832s","start":"2026-04-01T15:05:37.063286Z","end":"2026-04-01T15:05:39.112208Z","steps":["trace[2052839079] 'agreement among raft nodes before linearized reading' (duration: 2.048874501s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:39.112209Z","caller":"traceutil/trace.go:171","msg":"trace[2072730992] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:588; }","duration":"2.240904186s","start":"2026-04-01T15:05:36.871284Z","end":"2026-04-01T15:05:39.112188Z","steps":["trace[2072730992] 'agreement among raft nodes before linearized reading' (duration: 2.24050849s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112267Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.063267Z","time spent":"2.048982864s","remote":"127.0.0.1:49900","response type":"/etcdserverpb.KV/Range","request count":0,"request size":114,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true "} {"level":"info","ts":"2026-04-01T15:05:39.112267Z","caller":"traceutil/trace.go:171","msg":"trace[1579341537] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:588; }","duration":"2.048959643s","start":"2026-04-01T15:05:37.063287Z","end":"2026-04-01T15:05:39.112246Z","steps":["trace[1579341537] 'agreement among raft nodes before linearized reading' (duration: 2.04880272s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112279Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.976305321s","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-01T15:05:39.112283Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.871205Z","time spent":"2.2410616s","remote":"127.0.0.1:49880","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-01T15:05:39.112345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.063267Z","time spent":"2.049064955s","remote":"127.0.0.1:49900","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 "} {"level":"info","ts":"2026-04-01T15:05:39.112371Z","caller":"traceutil/trace.go:171","msg":"trace[402069041] 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:588; }","duration":"1.976383142s","start":"2026-04-01T15:05:37.135945Z","end":"2026-04-01T15:05:39.112328Z","steps":["trace[402069041] 'agreement among raft nodes before linearized reading' (duration: 1.97629631s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112406Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.13594Z","time spent":"1.976455423s","remote":"127.0.0.1:49926","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-01T15:05:39.112462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.080887048s","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":"info","ts":"2026-04-01T15:05:39.112512Z","caller":"traceutil/trace.go:171","msg":"trace[305738803] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:588; }","duration":"2.080944739s","start":"2026-04-01T15:05:37.031552Z","end":"2026-04-01T15:05:39.112497Z","steps":["trace[305738803] 'agreement among raft nodes before linearized reading' (duration: 2.080877038s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.031544Z","time spent":"2.08099091s","remote":"127.0.0.1:49890","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-01T15:05:39.112551Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.023419985s","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-01T15:05:39.11256Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.976988261s","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":"info","ts":"2026-04-01T15:05:39.112585Z","caller":"traceutil/trace.go:171","msg":"trace[718682754] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:588; }","duration":"2.023462305s","start":"2026-04-01T15:05:37.089111Z","end":"2026-04-01T15:05:39.112573Z","steps":["trace[718682754] 'agreement among raft nodes before linearized reading' (duration: 2.023395694s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112624Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.977237714s","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-01T15:05:39.112589Z","caller":"traceutil/trace.go:171","msg":"trace[1688693283] 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:588; }","duration":"1.977028001s","start":"2026-04-01T15:05:37.135553Z","end":"2026-04-01T15:05:39.112581Z","steps":["trace[1688693283] 'agreement among raft nodes before linearized reading' (duration: 1.976982561s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:39.112652Z","caller":"traceutil/trace.go:171","msg":"trace[217873505] 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:588; }","duration":"1.977280015s","start":"2026-04-01T15:05:37.135365Z","end":"2026-04-01T15:05:39.112645Z","steps":["trace[217873505] 'agreement among raft nodes before linearized reading' (duration: 1.977240855s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112692Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.135359Z","time spent":"1.977325736s","remote":"127.0.0.1:49926","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-01T15:05:39.11273Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.082230877s","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-01T15:05:39.112759Z","caller":"traceutil/trace.go:171","msg":"trace[556070262] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:588; }","duration":"2.082291189s","start":"2026-04-01T15:05:37.030459Z","end":"2026-04-01T15:05:39.112751Z","steps":["trace[556070262] 'agreement among raft nodes before linearized reading' (duration: 2.082253878s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.030439Z","time spent":"2.082349839s","remote":"127.0.0.1:49890","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-01T15:05:39.112861Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.993636053s","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-01T15:05:39.11291Z","caller":"traceutil/trace.go:171","msg":"trace[1885270] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:588; }","duration":"1.993716625s","start":"2026-04-01T15:05:37.119185Z","end":"2026-04-01T15:05:39.112901Z","steps":["trace[1885270] 'agreement among raft nodes before linearized reading' (duration: 1.993633964s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.11294Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.119176Z","time spent":"1.993755245s","remote":"127.0.0.1:49910","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-01T15:05:39.112761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.023664969s","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-01T15:05:39.113Z","caller":"traceutil/trace.go:171","msg":"trace[1020872884] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:588; }","duration":"2.023931322s","start":"2026-04-01T15:05:37.089059Z","end":"2026-04-01T15:05:39.11299Z","steps":["trace[1020872884] 'agreement among raft nodes before linearized reading' (duration: 2.023613028s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.113047Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.089041Z","time spent":"2.023994503s","remote":"127.0.0.1:49904","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-01T15:05:39.113071Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.994493945s","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-01T15:05:39.113106Z","caller":"traceutil/trace.go:171","msg":"trace[478361605] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:588; }","duration":"1.994532787s","start":"2026-04-01T15:05:37.118558Z","end":"2026-04-01T15:05:39.113091Z","steps":["trace[478361605] 'agreement among raft nodes before linearized reading' (duration: 1.994489666s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.049245187s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:39.113143Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.118554Z","time spent":"1.994580637s","remote":"127.0.0.1:49916","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":"info","ts":"2026-04-01T15:05:39.113151Z","caller":"traceutil/trace.go:171","msg":"trace[884418147] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:588; }","duration":"2.049537691s","start":"2026-04-01T15:05:37.063604Z","end":"2026-04-01T15:05:39.113142Z","steps":["trace[884418147] 'agreement among raft nodes before linearized reading' (duration: 2.049176276s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112625Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.089105Z","time spent":"2.023511046s","remote":"127.0.0.1:49904","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-01T15:05:39.113184Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.063598Z","time spent":"2.049576752s","remote":"127.0.0.1:49900","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 "} {"level":"warn","ts":"2026-04-01T15:05:39.112655Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.135548Z","time spent":"1.977100142s","remote":"127.0.0.1:49926","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-01T15:05:39.112225Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:38.633003Z","time spent":"479.217225ms","remote":"127.0.0.1:51120","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:39.112624Z","caller":"traceutil/trace.go:171","msg":"trace[865812779] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"2.326330721s","start":"2026-04-01T15:05:36.78627Z","end":"2026-04-01T15:05:39.112601Z","steps":["trace[865812779] 'process raft request' (duration: 2.324834208s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.112693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.082192597s","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":"warn","ts":"2026-04-01T15:05:39.113416Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.994858051s","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-01T15:05:39.113451Z","caller":"traceutil/trace.go:171","msg":"trace[576649296] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:588; }","duration":"2.082972088s","start":"2026-04-01T15:05:37.030459Z","end":"2026-04-01T15:05:39.113432Z","steps":["trace[576649296] 'agreement among raft nodes before linearized reading' (duration: 2.082209748s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:39.113493Z","caller":"traceutil/trace.go:171","msg":"trace[1448959780] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:588; }","duration":"1.994961122s","start":"2026-04-01T15:05:37.118519Z","end":"2026-04-01T15:05:39.11348Z","steps":["trace[1448959780] 'agreement among raft nodes before linearized reading' (duration: 1.99483225s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.11353Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.03044Z","time spent":"2.083057359s","remote":"127.0.0.1:49890","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-01T15:05:39.111903Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.240557371s","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":"warn","ts":"2026-04-01T15:05:39.113532Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.118512Z","time spent":"1.995008863s","remote":"127.0.0.1:49916","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":"info","ts":"2026-04-01T15:05:39.113582Z","caller":"traceutil/trace.go:171","msg":"trace[1880428504] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:588; }","duration":"2.242284196s","start":"2026-04-01T15:05:36.871288Z","end":"2026-04-01T15:05:39.113572Z","steps":["trace[1880428504] 'agreement among raft nodes before linearized reading' (duration: 2.24053032s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.11363Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.871266Z","time spent":"2.242347168s","remote":"127.0.0.1:49880","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-01T15:05:39.113545Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.006218933s","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":"warn","ts":"2026-04-01T15:05:39.113447Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:36.786252Z","time spent":"2.327151472s","remote":"127.0.0.1:51626","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:39.113675Z","caller":"traceutil/trace.go:171","msg":"trace[2024210249] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:588; }","duration":"2.006367807s","start":"2026-04-01T15:05:37.107295Z","end":"2026-04-01T15:05:39.113662Z","steps":["trace[2024210249] 'agreement among raft nodes before linearized reading' (duration: 2.006222514s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:39.113725Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:37.107282Z","time spent":"2.006427667s","remote":"127.0.0.1:49910","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":"info","ts":"2026-04-01T15:05:40.555523Z","caller":"traceutil/trace.go:171","msg":"trace[570029025] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"105.963822ms","start":"2026-04-01T15:05:40.44953Z","end":"2026-04-01T15:05:40.555494Z","steps":["trace[570029025] 'process raft request' (duration: 104.832826ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:40.767487Z","caller":"traceutil/trace.go:171","msg":"trace[935084468] linearizableReadLoop","detail":"{readStateIndex:626; appliedIndex:625; }","duration":"202.86928ms","start":"2026-04-01T15:05:40.564591Z","end":"2026-04-01T15:05:40.767461Z","steps":["trace[935084468] 'read index received' (duration: 134.334387ms)","trace[935084468] 'applied index is now lower than readState.Index' (duration: 68.533913ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:40.767629Z","caller":"traceutil/trace.go:171","msg":"trace[1914737027] transaction","detail":"{read_only:false; response_revision:603; number_of_response:1; }","duration":"306.832672ms","start":"2026-04-01T15:05:40.460771Z","end":"2026-04-01T15:05:40.767603Z","steps":["trace[1914737027] 'process raft request' (duration: 238.178567ms)","trace[1914737027] 'compare' (duration: 68.372381ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:40.767734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.841453ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:40.767779Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.176075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.65\" ","response":"range_response_count:1 size:133"} {"level":"warn","ts":"2026-04-01T15:05:40.767779Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:40.460746Z","time spent":"306.949834ms","remote":"127.0.0.1:51312","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17505,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:40.767835Z","caller":"traceutil/trace.go:171","msg":"trace[717116789] range","detail":"{range_begin:/registry/masterleases/199.204.45.65; range_end:; response_count:1; response_revision:603; }","duration":"203.278985ms","start":"2026-04-01T15:05:40.564542Z","end":"2026-04-01T15:05:40.767821Z","steps":["trace[717116789] 'agreement among raft nodes before linearized reading' (duration: 203.074183ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:40.767833Z","caller":"traceutil/trace.go:171","msg":"trace[1089019729] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:603; }","duration":"134.959975ms","start":"2026-04-01T15:05:40.632819Z","end":"2026-04-01T15:05:40.767779Z","steps":["trace[1089019729] 'agreement among raft nodes before linearized reading' (duration: 134.802143ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:41.260042Z","caller":"traceutil/trace.go:171","msg":"trace[1049911374] transaction","detail":"{read_only:false; response_revision:606; number_of_response:1; }","duration":"140.088022ms","start":"2026-04-01T15:05:41.119933Z","end":"2026-04-01T15:05:41.260021Z","steps":["trace[1049911374] 'process raft request' (duration: 139.821597ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:41.260022Z","caller":"traceutil/trace.go:171","msg":"trace[1093047037] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"140.01582ms","start":"2026-04-01T15:05:41.119976Z","end":"2026-04-01T15:05:41.259992Z","steps":["trace[1093047037] 'process raft request' (duration: 139.965909ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:41.41392Z","caller":"traceutil/trace.go:171","msg":"trace[630955404] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"216.460735ms","start":"2026-04-01T15:05:41.197428Z","end":"2026-04-01T15:05:41.413889Z","steps":["trace[630955404] 'process raft request' (duration: 156.131549ms)","trace[630955404] 'compare' (duration: 60.153564ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:41.414031Z","caller":"traceutil/trace.go:171","msg":"trace[1292170576] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"209.723366ms","start":"2026-04-01T15:05:41.204254Z","end":"2026-04-01T15:05:41.413978Z","steps":["trace[1292170576] 'process raft request' (duration: 209.586824ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:41.602473Z","caller":"traceutil/trace.go:171","msg":"trace[1269766148] transaction","detail":"{read_only:false; response_revision:616; number_of_response:1; }","duration":"114.578262ms","start":"2026-04-01T15:05:41.487874Z","end":"2026-04-01T15:05:41.602452Z","steps":["trace[1269766148] 'process raft request' (duration: 114.517531ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:41.602538Z","caller":"traceutil/trace.go:171","msg":"trace[1926216244] transaction","detail":"{read_only:false; response_revision:615; number_of_response:1; }","duration":"117.144521ms","start":"2026-04-01T15:05:41.485355Z","end":"2026-04-01T15:05:41.602499Z","steps":["trace[1926216244] 'process raft request' (duration: 116.924198ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.203844Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.197824ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-04-01T15:05:42.203962Z","caller":"traceutil/trace.go:171","msg":"trace[824533132] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"622.741047ms","start":"2026-04-01T15:05:41.581199Z","end":"2026-04-01T15:05:42.20394Z","steps":["trace[824533132] 'process raft request' (duration: 440.373571ms)","trace[824533132] 'compare' (duration: 181.799347ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:42.20402Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.581178Z","time spent":"622.817098ms","remote":"127.0.0.1:51178","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":722,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:42.212739Z","caller":"traceutil/trace.go:171","msg":"trace[1771636757] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"601.781295ms","start":"2026-04-01T15:05:41.610934Z","end":"2026-04-01T15:05:42.212715Z","steps":["trace[1771636757] 'process raft request' (duration: 601.695743ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:42.213026Z","caller":"traceutil/trace.go:171","msg":"trace[1579360320] linearizableReadLoop","detail":"{readStateIndex:644; appliedIndex:640; }","duration":"579.601805ms","start":"2026-04-01T15:05:41.633401Z","end":"2026-04-01T15:05:42.213003Z","steps":["trace[1579360320] 'read index received' (duration: 388.182295ms)","trace[1579360320] 'applied index is now lower than readState.Index' (duration: 191.4186ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:42.213043Z","caller":"traceutil/trace.go:171","msg":"trace[581547159] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"546.094267ms","start":"2026-04-01T15:05:41.666929Z","end":"2026-04-01T15:05:42.213024Z","steps":["trace[581547159] 'process raft request' (duration: 545.756592ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.213132Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"579.718966ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:42.213168Z","caller":"traceutil/trace.go:171","msg":"trace[1118886607] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:622; }","duration":"579.789488ms","start":"2026-04-01T15:05:41.633367Z","end":"2026-04-01T15:05:42.213157Z","steps":["trace[1118886607] 'agreement among raft nodes before linearized reading' (duration: 579.710627ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.213181Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.666916Z","time spent":"546.173268ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3353,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:42.213204Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.633355Z","time spent":"579.842208ms","remote":"127.0.0.1:51126","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-01T15:05:42.213361Z","caller":"traceutil/trace.go:171","msg":"trace[2085834608] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"345.374385ms","start":"2026-04-01T15:05:41.867976Z","end":"2026-04-01T15:05:42.21335Z","steps":["trace[2085834608] 'process raft request' (duration: 344.954459ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.213423Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.867952Z","time spent":"345.441545ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3202,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-01T15:05:42.212795Z","caller":"traceutil/trace.go:171","msg":"trace[796877083] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"602.965052ms","start":"2026-04-01T15:05:41.609801Z","end":"2026-04-01T15:05:42.212766Z","steps":["trace[796877083] 'process raft request' (duration: 602.76672ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.213758Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.609793Z","time spent":"603.882766ms","remote":"127.0.0.1:51592","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4387,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:42.213686Z","caller":"traceutil/trace.go:171","msg":"trace[914814750] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"606.071638ms","start":"2026-04-01T15:05:41.607596Z","end":"2026-04-01T15:05:42.213668Z","steps":["trace[914814750] 'process raft request' (duration: 604.84159ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:42.214084Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.607587Z","time spent":"606.350412ms","remote":"127.0.0.1:51630","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":950,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:42.215457Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:41.610928Z","time spent":"604.471814ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9296,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:42.224384Z","caller":"traceutil/trace.go:171","msg":"trace[90700871] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"154.157509ms","start":"2026-04-01T15:05:42.070208Z","end":"2026-04-01T15:05:42.224365Z","steps":["trace[90700871] 'process raft request' (duration: 154.046167ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:44.749606Z","caller":"traceutil/trace.go:171","msg":"trace[1224119605] transaction","detail":"{read_only:false; response_revision:663; number_of_response:1; }","duration":"256.932549ms","start":"2026-04-01T15:05:44.49264Z","end":"2026-04-01T15:05:44.749573Z","steps":["trace[1224119605] 'process raft request' (duration: 256.008376ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:45.409308Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.174848ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:45.409405Z","caller":"traceutil/trace.go:171","msg":"trace[1020140602] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:665; }","duration":"124.28134ms","start":"2026-04-01T15:05:45.285108Z","end":"2026-04-01T15:05:45.409389Z","steps":["trace[1020140602] 'range keys from in-memory index tree' (duration: 124.161948ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:45.428786Z","caller":"traceutil/trace.go:171","msg":"trace[1519987939] linearizableReadLoop","detail":"{readStateIndex:690; appliedIndex:689; }","duration":"201.276181ms","start":"2026-04-01T15:05:45.22748Z","end":"2026-04-01T15:05:45.428756Z","steps":["trace[1519987939] 'read index received' (duration: 201.002947ms)","trace[1519987939] 'applied index is now lower than readState.Index' (duration: 271.934µs)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:45.428911Z","caller":"traceutil/trace.go:171","msg":"trace[2114536221] transaction","detail":"{read_only:false; response_revision:666; number_of_response:1; }","duration":"330.499912ms","start":"2026-04-01T15:05:45.098386Z","end":"2026-04-01T15:05:45.428886Z","steps":["trace[2114536221] 'process raft request' (duration: 330.165087ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:45.429002Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:45.098365Z","time spent":"330.582583ms","remote":"127.0.0.1:51152","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":187246,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-01T15:05:45.429155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.660226ms","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-01T15:05:45.42921Z","caller":"traceutil/trace.go:171","msg":"trace[523421617] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:666; }","duration":"201.755157ms","start":"2026-04-01T15:05:45.227428Z","end":"2026-04-01T15:05:45.429183Z","steps":["trace[523421617] 'agreement among raft nodes before linearized reading' (duration: 201.554274ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:45.429245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.955161ms","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-01T15:05:45.429274Z","caller":"traceutil/trace.go:171","msg":"trace[721795165] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:666; }","duration":"110.027771ms","start":"2026-04-01T15:05:45.319238Z","end":"2026-04-01T15:05:45.429266Z","steps":["trace[721795165] 'agreement among raft nodes before linearized reading' (duration: 109.905479ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:45.429374Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.129834ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumexternalworkloads.cilium.io\" ","response":"range_response_count:1 size:5586"} {"level":"info","ts":"2026-04-01T15:05:45.429462Z","caller":"traceutil/trace.go:171","msg":"trace[1927204014] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumexternalworkloads.cilium.io; range_end:; response_count:1; response_revision:666; }","duration":"163.317277ms","start":"2026-04-01T15:05:45.266124Z","end":"2026-04-01T15:05:45.429442Z","steps":["trace[1927204014] 'agreement among raft nodes before linearized reading' (duration: 162.956792ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:45.429833Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.1404ms","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-01T15:05:45.43Z","caller":"traceutil/trace.go:171","msg":"trace[726854127] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:666; }","duration":"142.346732ms","start":"2026-04-01T15:05:45.287598Z","end":"2026-04-01T15:05:45.429944Z","steps":["trace[726854127] 'agreement among raft nodes before linearized reading' (duration: 141.654362ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:47.004747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.398118ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:47.004852Z","caller":"traceutil/trace.go:171","msg":"trace[1660144107] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:691; }","duration":"101.563452ms","start":"2026-04-01T15:05:46.903267Z","end":"2026-04-01T15:05:47.00483Z","steps":["trace[1660144107] 'range keys from in-memory index tree' (duration: 101.275187ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:47.004804Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.288068ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:47.0048Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.702204ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:47.005228Z","caller":"traceutil/trace.go:171","msg":"trace[982499819] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:691; }","duration":"102.197681ms","start":"2026-04-01T15:05:46.903005Z","end":"2026-04-01T15:05:47.005203Z","steps":["trace[982499819] 'count revisions from in-memory index tree' (duration: 101.606081ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:47.005058Z","caller":"traceutil/trace.go:171","msg":"trace[1811771728] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:691; }","duration":"101.45624ms","start":"2026-04-01T15:05:46.903447Z","end":"2026-04-01T15:05:47.004904Z","steps":["trace[1811771728] 'range keys from in-memory index tree' (duration: 101.200467ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:48.055591Z","caller":"traceutil/trace.go:171","msg":"trace[1553121386] transaction","detail":"{read_only:false; response_revision:697; number_of_response:1; }","duration":"225.958983ms","start":"2026-04-01T15:05:47.829596Z","end":"2026-04-01T15:05:48.055555Z","steps":["trace[1553121386] 'process raft request' (duration: 225.761171ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:48.080122Z","caller":"traceutil/trace.go:171","msg":"trace[1150278933] transaction","detail":"{read_only:false; number_of_response:0; response_revision:697; }","duration":"248.696461ms","start":"2026-04-01T15:05:47.831401Z","end":"2026-04-01T15:05:48.080097Z","steps":["trace[1150278933] 'process raft request' (duration: 248.593689ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:48.235128Z","caller":"traceutil/trace.go:171","msg":"trace[1521681908] transaction","detail":"{read_only:false; response_revision:699; number_of_response:1; }","duration":"103.737778ms","start":"2026-04-01T15:05:48.131369Z","end":"2026-04-01T15:05:48.235107Z","steps":["trace[1521681908] 'process raft request' (duration: 49.359278ms)","trace[1521681908] 'compare' (duration: 54.114707ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:49.884176Z","caller":"traceutil/trace.go:171","msg":"trace[1746419403] transaction","detail":"{read_only:false; response_revision:710; number_of_response:1; }","duration":"109.365791ms","start":"2026-04-01T15:05:49.774771Z","end":"2026-04-01T15:05:49.884137Z","steps":["trace[1746419403] 'process raft request' (duration: 58.354533ms)","trace[1746419403] 'compare' (duration: 50.872146ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:51.757617Z","caller":"traceutil/trace.go:171","msg":"trace[352336492] linearizableReadLoop","detail":"{readStateIndex:747; appliedIndex:746; }","duration":"123.836581ms","start":"2026-04-01T15:05:51.633754Z","end":"2026-04-01T15:05:51.757591Z","steps":["trace[352336492] 'read index received' (duration: 123.647638ms)","trace[352336492] 'applied index is now lower than readState.Index' (duration: 184.003µs)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:51.757803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.014914ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:51.75786Z","caller":"traceutil/trace.go:171","msg":"trace[167659836] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:720; }","duration":"124.119135ms","start":"2026-04-01T15:05:51.633725Z","end":"2026-04-01T15:05:51.757844Z","steps":["trace[167659836] 'agreement among raft nodes before linearized reading' (duration: 123.997994ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:51.757658Z","caller":"traceutil/trace.go:171","msg":"trace[5485989] transaction","detail":"{read_only:false; response_revision:720; number_of_response:1; }","duration":"128.221383ms","start":"2026-04-01T15:05:51.629406Z","end":"2026-04-01T15:05:51.757627Z","steps":["trace[5485989] 'process raft request' (duration: 128.01082ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:51.782229Z","caller":"traceutil/trace.go:171","msg":"trace[689761393] transaction","detail":"{read_only:false; response_revision:721; number_of_response:1; }","duration":"105.480473ms","start":"2026-04-01T15:05:51.676725Z","end":"2026-04-01T15:05:51.782205Z","steps":["trace[689761393] 'process raft request' (duration: 105.337161ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:51.782473Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.352658ms","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-01T15:05:51.782587Z","caller":"traceutil/trace.go:171","msg":"trace[1050448385] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:721; }","duration":"131.53289ms","start":"2026-04-01T15:05:51.651035Z","end":"2026-04-01T15:05:51.782568Z","steps":["trace[1050448385] 'agreement among raft nodes before linearized reading' (duration: 131.206406ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:54.014214Z","caller":"traceutil/trace.go:171","msg":"trace[690068177] linearizableReadLoop","detail":"{readStateIndex:765; appliedIndex:764; }","duration":"380.593084ms","start":"2026-04-01T15:05:53.633599Z","end":"2026-04-01T15:05:54.014192Z","steps":["trace[690068177] 'read index received' (duration: 380.469062ms)","trace[690068177] 'applied index is now lower than readState.Index' (duration: 123.062µs)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:05:54.014379Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"380.754456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:05:54.014415Z","caller":"traceutil/trace.go:171","msg":"trace[13652923] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:738; }","duration":"380.830517ms","start":"2026-04-01T15:05:53.633575Z","end":"2026-04-01T15:05:54.014405Z","steps":["trace[13652923] 'agreement among raft nodes before linearized reading' (duration: 380.751766ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:54.014464Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:53.633565Z","time spent":"380.892587ms","remote":"127.0.0.1:51126","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-01T15:05:54.014483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.469873ms","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-01T15:05:54.014507Z","caller":"traceutil/trace.go:171","msg":"trace[28781467] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:738; }","duration":"164.529905ms","start":"2026-04-01T15:05:53.849971Z","end":"2026-04-01T15:05:54.014501Z","steps":["trace[28781467] 'agreement among raft nodes before linearized reading' (duration: 164.405183ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:54.01446Z","caller":"traceutil/trace.go:171","msg":"trace[1797085537] transaction","detail":"{read_only:false; response_revision:738; number_of_response:1; }","duration":"382.801485ms","start":"2026-04-01T15:05:53.631452Z","end":"2026-04-01T15:05:54.014253Z","steps":["trace[1797085537] 'process raft request' (duration: 382.613392ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:54.014628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.465007ms","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-01T15:05:54.014754Z","caller":"traceutil/trace.go:171","msg":"trace[1319300520] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:738; }","duration":"252.6643ms","start":"2026-04-01T15:05:53.762076Z","end":"2026-04-01T15:05:54.01474Z","steps":["trace[1319300520] 'agreement among raft nodes before linearized reading' (duration: 252.293465ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:54.014753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:53.631434Z","time spent":"383.21294ms","remote":"127.0.0.1:51382","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-01T15:05:56.525245Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073502988,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-01T15:05:57.025958Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073502988,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-01T15:05:57.173177Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.150509899s","expected-duration":"1s"} {"level":"info","ts":"2026-04-01T15:05:57.173746Z","caller":"traceutil/trace.go:171","msg":"trace[1546571380] transaction","detail":"{read_only:false; response_revision:752; number_of_response:1; }","duration":"1.151164117s","start":"2026-04-01T15:05:56.022552Z","end":"2026-04-01T15:05:57.173716Z","steps":["trace[1546571380] 'process raft request' (duration: 1.150966035s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:57.173972Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:56.022528Z","time spent":"1.151273148s","remote":"127.0.0.1:51382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-01T15:05:57.312515Z","caller":"traceutil/trace.go:171","msg":"trace[1731482890] linearizableReadLoop","detail":"{readStateIndex:781; appliedIndex:778; }","duration":"1.287745448s","start":"2026-04-01T15:05:56.024749Z","end":"2026-04-01T15:05:57.312494Z","steps":["trace[1731482890] 'read index received' (duration: 1.148649642s)","trace[1731482890] 'applied index is now lower than readState.Index' (duration: 139.094976ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:05:57.312605Z","caller":"traceutil/trace.go:171","msg":"trace[713673382] transaction","detail":"{read_only:false; response_revision:753; number_of_response:1; }","duration":"756.706425ms","start":"2026-04-01T15:05:56.555892Z","end":"2026-04-01T15:05:57.312598Z","steps":["trace[713673382] 'process raft request' (duration: 756.484961ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:57.312805Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:56.555864Z","time spent":"756.877067ms","remote":"127.0.0.1:51362","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-01T15:05:57.31282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"679.02498ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-01T15:05:57.312849Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.288096452s","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-01T15:05:57.312857Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.287659277s","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-01T15:05:57.312896Z","caller":"traceutil/trace.go:171","msg":"trace[2119084136] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:753; }","duration":"1.288175674s","start":"2026-04-01T15:05:56.024707Z","end":"2026-04-01T15:05:57.312883Z","steps":["trace[2119084136] 'agreement among raft nodes before linearized reading' (duration: 1.287985211s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:05:57.312893Z","caller":"traceutil/trace.go:171","msg":"trace[222273424] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:753; }","duration":"679.135072ms","start":"2026-04-01T15:05:56.63374Z","end":"2026-04-01T15:05:57.312875Z","steps":["trace[222273424] 'agreement among raft nodes before linearized reading' (duration: 679.01479ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:57.312939Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:56.633721Z","time spent":"679.211252ms","remote":"127.0.0.1:51120","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-01T15:05:57.312937Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:56.024695Z","time spent":"1.288234314s","remote":"127.0.0.1:51382","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-01T15:05:57.312939Z","caller":"traceutil/trace.go:171","msg":"trace[1940163330] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:753; }","duration":"1.287796798s","start":"2026-04-01T15:05:56.025122Z","end":"2026-04-01T15:05:57.312919Z","steps":["trace[1940163330] 'agreement among raft nodes before linearized reading' (duration: 1.287542435s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:05:57.312989Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:05:56.025111Z","time spent":"1.28786934s","remote":"127.0.0.1:51382","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-01T15:07:46.06282Z","caller":"traceutil/trace.go:171","msg":"trace[411712611] transaction","detail":"{read_only:false; response_revision:1277; number_of_response:1; }","duration":"121.654856ms","start":"2026-04-01T15:07:45.94115Z","end":"2026-04-01T15:07:46.062805Z","steps":["trace[411712611] 'process raft request' (duration: 121.06599ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.327834Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620625576073504320,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-01T15:07:52.825334Z","caller":"traceutil/trace.go:171","msg":"trace[196676731] transaction","detail":"{read_only:false; response_revision:1299; number_of_response:1; }","duration":"1.113567503s","start":"2026-04-01T15:07:51.711749Z","end":"2026-04-01T15:07:52.825316Z","steps":["trace[196676731] 'process raft request' (duration: 1.113457362s)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.825608Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:51.711728Z","time spent":"1.113659914s","remote":"127.0.0.1:51382","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-01T15:07:52.859549Z","caller":"traceutil/trace.go:171","msg":"trace[383220249] linearizableReadLoop","detail":"{readStateIndex:1355; appliedIndex:1353; }","duration":"1.032658456s","start":"2026-04-01T15:07:51.826865Z","end":"2026-04-01T15:07:52.859524Z","steps":["trace[383220249] 'read index received' (duration: 998.405133ms)","trace[383220249] 'applied index is now lower than readState.Index' (duration: 34.252233ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:07:52.859608Z","caller":"traceutil/trace.go:171","msg":"trace[2115900793] transaction","detail":"{read_only:false; response_revision:1300; number_of_response:1; }","duration":"781.464373ms","start":"2026-04-01T15:07:52.078119Z","end":"2026-04-01T15:07:52.859583Z","steps":["trace[2115900793] 'process raft request' (duration: 781.288522ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.859844Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:52.078086Z","time spent":"781.570015ms","remote":"127.0.0.1:51382","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-01T15:07:52.859888Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"718.052792ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-04-01T15:07:52.859946Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"774.081016ms","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-01T15:07:52.859972Z","caller":"traceutil/trace.go:171","msg":"trace[1479271253] range","detail":"{range_begin:/registry/leases/; range_end:/registry/leases0; response_count:0; response_revision:1300; }","duration":"718.188244ms","start":"2026-04-01T15:07:52.141764Z","end":"2026-04-01T15:07:52.859952Z","steps":["trace[1479271253] 'agreement among raft nodes before linearized reading' (duration: 718.051873ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.859864Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.012232889s","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-01T15:07:52.860035Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"775.152387ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"warn","ts":"2026-04-01T15:07:52.860095Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.032942389s","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-01T15:07:52.860172Z","caller":"traceutil/trace.go:171","msg":"trace[2122313068] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1300; }","duration":"1.012517242s","start":"2026-04-01T15:07:51.847554Z","end":"2026-04-01T15:07:52.860072Z","steps":["trace[2122313068] 'agreement among raft nodes before linearized reading' (duration: 1.012191439s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:52.860184Z","caller":"traceutil/trace.go:171","msg":"trace[1380681406] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1300; }","duration":"1.033368623s","start":"2026-04-01T15:07:51.826801Z","end":"2026-04-01T15:07:52.860169Z","steps":["trace[1380681406] 'agreement among raft nodes before linearized reading' (duration: 1.032857508s)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:52.860105Z","caller":"traceutil/trace.go:171","msg":"trace[691782683] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1300; }","duration":"775.253567ms","start":"2026-04-01T15:07:52.084833Z","end":"2026-04-01T15:07:52.860087Z","steps":["trace[691782683] 'agreement among raft nodes before linearized reading' (duration: 775.030975ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.86037Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:51.826777Z","time spent":"1.033496524s","remote":"127.0.0.1:51382","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-01T15:07:52.860381Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:52.084817Z","time spent":"775.54718ms","remote":"127.0.0.1:51382","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-04-01T15:07:52.860028Z","caller":"traceutil/trace.go:171","msg":"trace[339545139] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1300; }","duration":"774.186017ms","start":"2026-04-01T15:07:52.085818Z","end":"2026-04-01T15:07:52.860004Z","steps":["trace[339545139] 'agreement among raft nodes before linearized reading' (duration: 774.013135ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:52.860459Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:52.085805Z","time spent":"774.641443ms","remote":"127.0.0.1:51382","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-01T15:07:52.86002Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:52.141743Z","time spent":"718.266685ms","remote":"127.0.0.1:51382","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":8,"response size":31,"request content":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:07:52.860344Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:51.847537Z","time spent":"1.012721204s","remote":"127.0.0.1:51382","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-01T15:07:53.013135Z","caller":"traceutil/trace.go:171","msg":"trace[1402164411] transaction","detail":"{read_only:false; response_revision:1302; number_of_response:1; }","duration":"147.977457ms","start":"2026-04-01T15:07:52.865123Z","end":"2026-04-01T15:07:53.0131Z","steps":["trace[1402164411] 'process raft request' (duration: 147.479602ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:53.013211Z","caller":"traceutil/trace.go:171","msg":"trace[1721820077] transaction","detail":"{read_only:false; response_revision:1304; number_of_response:1; }","duration":"146.301069ms","start":"2026-04-01T15:07:52.866873Z","end":"2026-04-01T15:07:53.013174Z","steps":["trace[1721820077] 'process raft request' (duration: 146.177838ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:53.013172Z","caller":"traceutil/trace.go:171","msg":"trace[1463631258] transaction","detail":"{read_only:false; response_revision:1303; number_of_response:1; }","duration":"147.984907ms","start":"2026-04-01T15:07:52.865154Z","end":"2026-04-01T15:07:53.013139Z","steps":["trace[1463631258] 'process raft request' (duration: 147.781024ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:53.013498Z","caller":"traceutil/trace.go:171","msg":"trace[73066739] transaction","detail":"{read_only:false; response_revision:1301; number_of_response:1; }","duration":"147.952547ms","start":"2026-04-01T15:07:52.865101Z","end":"2026-04-01T15:07:53.013054Z","steps":["trace[73066739] 'process raft request' (duration: 54.714279ms)","trace[73066739] 'compare' (duration: 92.56042ms)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:07:53.013693Z","caller":"traceutil/trace.go:171","msg":"trace[1989009986] linearizableReadLoop","detail":"{readStateIndex:1358; appliedIndex:1355; }","duration":"146.24173ms","start":"2026-04-01T15:07:52.86687Z","end":"2026-04-01T15:07:53.013112Z","steps":["trace[1989009986] 'read index received' (duration: 52.971852ms)","trace[1989009986] 'applied index is now lower than readState.Index' (duration: 93.268408ms)"],"step_count":2} {"level":"warn","ts":"2026-04-01T15:07:53.013807Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.906376ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/test-pv\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:07:53.01388Z","caller":"traceutil/trace.go:171","msg":"trace[1530171552] range","detail":"{range_begin:/registry/persistentvolumes/test-pv; range_end:; response_count:0; response_revision:1304; }","duration":"147.012777ms","start":"2026-04-01T15:07:52.86685Z","end":"2026-04-01T15:07:53.013862Z","steps":["trace[1530171552] 'agreement among raft nodes before linearized reading' (duration: 146.883016ms)"],"step_count":1} {"level":"info","ts":"2026-04-01T15:07:53.857514Z","caller":"traceutil/trace.go:171","msg":"trace[1910920995] linearizableReadLoop","detail":"{readStateIndex:1360; appliedIndex:1359; }","duration":"339.448551ms","start":"2026-04-01T15:07:53.518041Z","end":"2026-04-01T15:07:53.85749Z","steps":["trace[1910920995] 'read index received' (duration: 339.270378ms)","trace[1910920995] 'applied index is now lower than readState.Index' (duration: 177.123µs)"],"step_count":2} {"level":"info","ts":"2026-04-01T15:07:53.857633Z","caller":"traceutil/trace.go:171","msg":"trace[481938453] transaction","detail":"{read_only:false; response_revision:1305; number_of_response:1; }","duration":"422.456919ms","start":"2026-04-01T15:07:53.435147Z","end":"2026-04-01T15:07:53.857604Z","steps":["trace[481938453] 'process raft request' (duration: 422.153695ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:53.857763Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"339.709543ms","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":"info","ts":"2026-04-01T15:07:53.857802Z","caller":"traceutil/trace.go:171","msg":"trace[2145366403] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1305; }","duration":"339.819625ms","start":"2026-04-01T15:07:53.517973Z","end":"2026-04-01T15:07:53.857793Z","steps":["trace[2145366403] 'agreement among raft nodes before linearized reading' (duration: 339.657713ms)"],"step_count":1} {"level":"warn","ts":"2026-04-01T15:07:53.857792Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:53.435114Z","time spent":"422.59224ms","remote":"127.0.0.1:51382","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-01T15:07:53.857839Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-01T15:07:53.517951Z","time spent":"339.878295ms","remote":"127.0.0.1:51628","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":113,"response size":31,"request content":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true "} {"level":"warn","ts":"2026-04-01T15:07:53.8581Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.606285ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-01T15:07:53.858181Z","caller":"traceutil/trace.go:171","msg":"trace[76107262] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1305; }","duration":"224.750147ms","start":"2026-04-01T15:07:53.633412Z","end":"2026-04-01T15:07:53.858163Z","steps":["trace[76107262] 'agreement among raft nodes before linearized reading' (duration: 224.590466ms)"],"step_count":1}