{"level":"warn","ts":"2026-05-27T19:34:43.202645Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-27T19:34:43.202767Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.40:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.40:2380","--initial-cluster=instance=https://199.19.213.40:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.40:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.40: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-05-27T19:34:43.202839Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-27T19:34:43.20285Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.40:2380"]} {"level":"info","ts":"2026-05-27T19:34:43.202874Z","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-05-27T19:34:43.203661Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.40:2379"]} {"level":"info","ts":"2026-05-27T19:34:43.203746Z","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.19.213.40:2380"],"listen-peer-urls":["https://199.19.213.40:2380"],"advertise-client-urls":["https://199.19.213.40:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.40:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.40: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-05-27T19:34:43.210604Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.639174ms"} {"level":"info","ts":"2026-05-27T19:34:43.231429Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"1082227b3dfb8db7","cluster-id":"1c36bbf7868e18b9"} {"level":"info","ts":"2026-05-27T19:34:43.231531Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 switched to configuration voters=()"} {"level":"info","ts":"2026-05-27T19:34:43.231566Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 became follower at term 0"} {"level":"info","ts":"2026-05-27T19:34:43.231587Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 1082227b3dfb8db7 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-27T19:34:43.231605Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 became follower at term 1"} {"level":"info","ts":"2026-05-27T19:34:43.231658Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 switched to configuration voters=(1189551164295450039)"} {"level":"warn","ts":"2026-05-27T19:34:43.24447Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-27T19:34:43.247164Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-27T19:34:43.248694Z","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-05-27T19:34:43.250973Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"1082227b3dfb8db7","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-27T19:34:43.251127Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"1082227b3dfb8db7","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-27T19:34:43.252127Z","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-05-27T19:34:43.252285Z","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-05-27T19:34:43.252311Z","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-05-27T19:34:43.252948Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 switched to configuration voters=(1189551164295450039)"} {"level":"info","ts":"2026-05-27T19:34:43.253153Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"1c36bbf7868e18b9","local-member-id":"1082227b3dfb8db7","added-peer-id":"1082227b3dfb8db7","added-peer-peer-urls":["https://199.19.213.40:2380"]} {"level":"info","ts":"2026-05-27T19:34:43.260702Z","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-05-27T19:34:43.260817Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.40:2380"} {"level":"info","ts":"2026-05-27T19:34:43.260876Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.40:2380"} {"level":"info","ts":"2026-05-27T19:34:43.26109Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"1082227b3dfb8db7","initial-advertise-peer-urls":["https://199.19.213.40:2380"],"listen-peer-urls":["https://199.19.213.40:2380"],"advertise-client-urls":["https://199.19.213.40:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.40:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-27T19:34:43.261215Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-27T19:34:43.832309Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 is starting a new election at term 1"} {"level":"info","ts":"2026-05-27T19:34:43.832383Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 became pre-candidate at term 1"} {"level":"info","ts":"2026-05-27T19:34:43.832435Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 received MsgPreVoteResp from 1082227b3dfb8db7 at term 1"} {"level":"info","ts":"2026-05-27T19:34:43.832508Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 became candidate at term 2"} {"level":"info","ts":"2026-05-27T19:34:43.832564Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 received MsgVoteResp from 1082227b3dfb8db7 at term 2"} {"level":"info","ts":"2026-05-27T19:34:43.832585Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1082227b3dfb8db7 became leader at term 2"} {"level":"info","ts":"2026-05-27T19:34:43.832605Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 1082227b3dfb8db7 elected leader 1082227b3dfb8db7 at term 2"} {"level":"info","ts":"2026-05-27T19:34:43.848745Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"1082227b3dfb8db7","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.40:2379]}","request-path":"/0/members/1082227b3dfb8db7/attributes","cluster-id":"1c36bbf7868e18b9","publish-timeout":"7s"} {"level":"info","ts":"2026-05-27T19:34:43.848843Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-27T19:34:43.849034Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-27T19:34:43.849432Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-27T19:34:43.84945Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-27T19:34:43.849709Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T19:34:43.852507Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-27T19:34:43.852624Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.40:2379"} {"level":"info","ts":"2026-05-27T19:34:43.855654Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"1c36bbf7868e18b9","local-member-id":"1082227b3dfb8db7","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T19:34:43.855865Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T19:34:43.855933Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-05-27T19:34:48.332384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.155520402s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-27T19:34:48.332432Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"732.414135ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:34:48.332517Z","caller":"traceutil/trace.go:171","msg":"trace[1709706995] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:240; }","duration":"1.155762633s","start":"2026-05-27T19:34:47.17673Z","end":"2026-05-27T19:34:48.332492Z","steps":["trace[1709706995] 'range keys from in-memory index tree' (duration: 1.155418691s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:48.332574Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:47.176706Z","time spent":"1.155858354s","remote":"127.0.0.1:34264","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-27T19:34:48.332565Z","caller":"traceutil/trace.go:171","msg":"trace[1694186692] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:240; }","duration":"732.655597ms","start":"2026-05-27T19:34:47.599879Z","end":"2026-05-27T19:34:48.332534Z","steps":["trace[1694186692] 'range keys from in-memory index tree' (duration: 732.267234ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:48.332688Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:47.599846Z","time spent":"732.825589ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-05-27T19:34:49.013452Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.053369352s","expected-duration":"1s"} {"level":"info","ts":"2026-05-27T19:34:49.013931Z","caller":"traceutil/trace.go:171","msg":"trace[428424004] transaction","detail":"{read_only:false; response_revision:241; number_of_response:1; }","duration":"1.053998806s","start":"2026-05-27T19:34:47.959901Z","end":"2026-05-27T19:34:49.0139Z","steps":["trace[428424004] 'process raft request' (duration: 1.053827205s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:49.014483Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:47.959866Z","time spent":"1.054145837s","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5498,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T19:34:49.590949Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":10211804862192886061,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-27T19:34:49.979747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"328.378694ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-27T19:34:49.980006Z","caller":"traceutil/trace.go:171","msg":"trace[1341321293] linearizableReadLoop","detail":"{readStateIndex:249; appliedIndex:247; }","duration":"889.066583ms","start":"2026-05-27T19:34:49.090918Z","end":"2026-05-27T19:34:49.979984Z","steps":["trace[1341321293] 'read index received' (duration: 560.078424ms)","trace[1341321293] 'applied index is now lower than readState.Index' (duration: 328.987019ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:49.980132Z","caller":"traceutil/trace.go:171","msg":"trace[959655006] transaction","detail":"{read_only:false; response_revision:242; number_of_response:1; }","duration":"1.641751986s","start":"2026-05-27T19:34:48.338363Z","end":"2026-05-27T19:34:49.980115Z","steps":["trace[959655006] 'process raft request' (duration: 1.312728567s)","trace[959655006] 'compare' (duration: 328.104172ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:34:49.980215Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:48.338297Z","time spent":"1.641881516s","remote":"127.0.0.1:34338","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1068,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T19:34:49.980285Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"889.357555ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:34:49.98035Z","caller":"traceutil/trace.go:171","msg":"trace[1336118485] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:243; }","duration":"889.456695ms","start":"2026-05-27T19:34:49.090876Z","end":"2026-05-27T19:34:49.980332Z","steps":["trace[1336118485] 'agreement among raft nodes before linearized reading' (duration: 889.297114ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:49.980387Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:49.090853Z","time spent":"889.526335ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-05-27T19:34:49.980454Z","caller":"traceutil/trace.go:171","msg":"trace[814421813] transaction","detail":"{read_only:false; response_revision:243; number_of_response:1; }","duration":"1.640991441s","start":"2026-05-27T19:34:48.339452Z","end":"2026-05-27T19:34:49.980444Z","steps":["trace[814421813] 'process raft request' (duration: 1.640455988s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:49.980507Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:48.339421Z","time spent":"1.641053081s","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T19:34:49.980524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"806.79271ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:34:49.980571Z","caller":"traceutil/trace.go:171","msg":"trace[939636157] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:0; response_revision:243; }","duration":"806.868161ms","start":"2026-05-27T19:34:49.173689Z","end":"2026-05-27T19:34:49.980557Z","steps":["trace[939636157] 'agreement among raft nodes before linearized reading' (duration: 806.80029ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:49.980614Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:49.173667Z","time spent":"806.936611ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-05-27T19:34:49.980747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"705.481485ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:34:49.980792Z","caller":"traceutil/trace.go:171","msg":"trace[574339436] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:0; response_revision:243; }","duration":"705.595215ms","start":"2026-05-27T19:34:49.275182Z","end":"2026-05-27T19:34:49.980778Z","steps":["trace[574339436] 'agreement among raft nodes before linearized reading' (duration: 705.528724ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:49.980833Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:49.275158Z","time spent":"705.664585ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-05-27T19:34:50.61709Z","caller":"traceutil/trace.go:171","msg":"trace[536019333] transaction","detail":"{read_only:false; response_revision:268; number_of_response:1; }","duration":"279.400587ms","start":"2026-05-27T19:34:50.337635Z","end":"2026-05-27T19:34:50.617036Z","steps":["trace[536019333] 'process raft request' (duration: 279.088865ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:52.314226Z","caller":"traceutil/trace.go:171","msg":"trace[1058787903] transaction","detail":"{read_only:false; response_revision:318; number_of_response:1; }","duration":"176.781626ms","start":"2026-05-27T19:34:52.137417Z","end":"2026-05-27T19:34:52.314198Z","steps":["trace[1058787903] 'process raft request' (duration: 137.968318ms)","trace[1058787903] 'compare' (duration: 38.680137ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:52.974254Z","caller":"traceutil/trace.go:171","msg":"trace[126582844] transaction","detail":"{read_only:false; number_of_response:0; response_revision:320; }","duration":"194.96225ms","start":"2026-05-27T19:34:52.779268Z","end":"2026-05-27T19:34:52.97423Z","steps":["trace[126582844] 'process raft request' (duration: 194.863569ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:53.123923Z","caller":"traceutil/trace.go:171","msg":"trace[2027656573] transaction","detail":"{read_only:false; number_of_response:0; response_revision:320; }","duration":"344.235578ms","start":"2026-05-27T19:34:52.779653Z","end":"2026-05-27T19:34:53.123889Z","steps":["trace[2027656573] 'process raft request' (duration: 344.093647ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:53.124054Z","caller":"traceutil/trace.go:171","msg":"trace[1822348910] linearizableReadLoop","detail":"{readStateIndex:337; appliedIndex:332; }","duration":"148.732213ms","start":"2026-05-27T19:34:52.975272Z","end":"2026-05-27T19:34:53.124004Z","steps":["trace[1822348910] 'read index received' (duration: 148.424812ms)","trace[1822348910] 'applied index is now lower than readState.Index' (duration: 306.551µs)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:34:53.124087Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:52.779639Z","time spent":"344.370948ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":27,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T19:34:53.124225Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.927675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-vip-instance\" ","response":"range_response_count:1 size:3466"} {"level":"info","ts":"2026-05-27T19:34:53.124258Z","caller":"traceutil/trace.go:171","msg":"trace[2075159990] range","detail":"{range_begin:/registry/pods/kube-system/kube-vip-instance; range_end:; response_count:1; response_revision:322; }","duration":"149.008155ms","start":"2026-05-27T19:34:52.97524Z","end":"2026-05-27T19:34:53.124248Z","steps":["trace[2075159990] 'agreement among raft nodes before linearized reading' (duration: 148.892194ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:53.124481Z","caller":"traceutil/trace.go:171","msg":"trace[628510396] transaction","detail":"{read_only:false; number_of_response:0; response_revision:320; }","duration":"343.829685ms","start":"2026-05-27T19:34:52.780639Z","end":"2026-05-27T19:34:53.124469Z","steps":["trace[628510396] 'process raft request' (duration: 343.198491ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:53.124572Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:52.780622Z","time spent":"343.923896ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":27,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T19:34:53.124569Z","caller":"traceutil/trace.go:171","msg":"trace[570536309] transaction","detail":"{read_only:false; response_revision:321; number_of_response:1; }","duration":"337.711386ms","start":"2026-05-27T19:34:52.786843Z","end":"2026-05-27T19:34:53.124554Z","steps":["trace[570536309] 'process raft request' (duration: 337.036112ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:53.124664Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:52.786819Z","time spent":"337.785966ms","remote":"127.0.0.1:34420","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":194,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T19:34:53.124691Z","caller":"traceutil/trace.go:171","msg":"trace[947635497] transaction","detail":"{read_only:false; number_of_response:0; response_revision:320; }","duration":"343.027589ms","start":"2026-05-27T19:34:52.781655Z","end":"2026-05-27T19:34:53.124683Z","steps":["trace[947635497] 'process raft request' (duration: 342.206115ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:53.124735Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:52.781648Z","time spent":"343.06631ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":27,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T19:34:53.124852Z","caller":"traceutil/trace.go:171","msg":"trace[55599292] transaction","detail":"{read_only:false; response_revision:322; number_of_response:1; }","duration":"328.456967ms","start":"2026-05-27T19:34:52.796384Z","end":"2026-05-27T19:34:53.124841Z","steps":["trace[55599292] 'process raft request' (duration: 327.568092ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:53.125082Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:34:52.796369Z","time spent":"328.508808ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5139,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:34:55.189033Z","caller":"traceutil/trace.go:171","msg":"trace[362894864] transaction","detail":"{read_only:false; response_revision:361; number_of_response:1; }","duration":"116.391171ms","start":"2026-05-27T19:34:55.072617Z","end":"2026-05-27T19:34:55.189008Z","steps":["trace[362894864] 'process raft request' (duration: 105.226701ms)","trace[362894864] 'compare' (duration: 10.561267ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:34:55.189186Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.706524ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/kube-system/coredns\" ","response":"range_response_count:1 size:3706"} {"level":"info","ts":"2026-05-27T19:34:55.188867Z","caller":"traceutil/trace.go:171","msg":"trace[1825350240] linearizableReadLoop","detail":"{readStateIndex:376; appliedIndex:375; }","duration":"110.360722ms","start":"2026-05-27T19:34:55.07847Z","end":"2026-05-27T19:34:55.18883Z","steps":["trace[1825350240] 'read index received' (duration: 99.285732ms)","trace[1825350240] 'applied index is now lower than readState.Index' (duration: 11.07356ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.189252Z","caller":"traceutil/trace.go:171","msg":"trace[723784846] range","detail":"{range_begin:/registry/deployments/kube-system/coredns; range_end:; response_count:1; response_revision:361; }","duration":"110.853555ms","start":"2026-05-27T19:34:55.078383Z","end":"2026-05-27T19:34:55.189237Z","steps":["trace[723784846] 'agreement among raft nodes before linearized reading' (duration: 110.715215ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:55.18944Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.690417ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" ","response":"range_response_count:1 size:218"} {"level":"info","ts":"2026-05-27T19:34:55.189487Z","caller":"traceutil/trace.go:171","msg":"trace[940751870] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:1; response_revision:361; }","duration":"101.779298ms","start":"2026-05-27T19:34:55.087692Z","end":"2026-05-27T19:34:55.189471Z","steps":["trace[940751870] 'agreement among raft nodes before linearized reading' (duration: 101.674537ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.334184Z","caller":"traceutil/trace.go:171","msg":"trace[114087828] transaction","detail":"{read_only:false; response_revision:364; number_of_response:1; }","duration":"136.484946ms","start":"2026-05-27T19:34:55.197675Z","end":"2026-05-27T19:34:55.33416Z","steps":["trace[114087828] 'process raft request' (duration: 136.342035ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.334217Z","caller":"traceutil/trace.go:171","msg":"trace[559769566] transaction","detail":"{read_only:false; response_revision:365; number_of_response:1; }","duration":"135.37769ms","start":"2026-05-27T19:34:55.198822Z","end":"2026-05-27T19:34:55.3342Z","steps":["trace[559769566] 'process raft request' (duration: 135.267659ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.334288Z","caller":"traceutil/trace.go:171","msg":"trace[324061614] transaction","detail":"{read_only:false; response_revision:363; number_of_response:1; }","duration":"136.668008ms","start":"2026-05-27T19:34:55.197564Z","end":"2026-05-27T19:34:55.334232Z","steps":["trace[324061614] 'process raft request' (duration: 113.605003ms)","trace[324061614] 'compare' (duration: 22.706073ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.334503Z","caller":"traceutil/trace.go:171","msg":"trace[4578094] transaction","detail":"{read_only:false; response_revision:366; number_of_response:1; }","duration":"129.317071ms","start":"2026-05-27T19:34:55.205156Z","end":"2026-05-27T19:34:55.334473Z","steps":["trace[4578094] 'process raft request' (duration: 128.982519ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:55.337972Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.032953ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller\" ","response":"range_response_count:1 size:234"} {"level":"info","ts":"2026-05-27T19:34:55.338065Z","caller":"traceutil/trace.go:171","msg":"trace[340277575] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller; range_end:; response_count:1; response_revision:367; }","duration":"101.179705ms","start":"2026-05-27T19:34:55.236864Z","end":"2026-05-27T19:34:55.338043Z","steps":["trace[340277575] 'agreement among raft nodes before linearized reading' (duration: 97.748694ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.544418Z","caller":"traceutil/trace.go:171","msg":"trace[2016896897] transaction","detail":"{read_only:false; response_revision:368; number_of_response:1; }","duration":"198.683737ms","start":"2026-05-27T19:34:55.345693Z","end":"2026-05-27T19:34:55.544376Z","steps":["trace[2016896897] 'process raft request' (duration: 176.334336ms)","trace[2016896897] 'compare' (duration: 22.122549ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.544712Z","caller":"traceutil/trace.go:171","msg":"trace[2034577322] transaction","detail":"{read_only:false; response_revision:371; number_of_response:1; }","duration":"196.474773ms","start":"2026-05-27T19:34:55.348211Z","end":"2026-05-27T19:34:55.544686Z","steps":["trace[2034577322] 'process raft request' (duration: 196.309562ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.544836Z","caller":"traceutil/trace.go:171","msg":"trace[786978879] transaction","detail":"{read_only:false; response_revision:372; number_of_response:1; }","duration":"196.544533ms","start":"2026-05-27T19:34:55.348256Z","end":"2026-05-27T19:34:55.544801Z","steps":["trace[786978879] 'process raft request' (duration: 196.308302ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.544625Z","caller":"traceutil/trace.go:171","msg":"trace[206600145] linearizableReadLoop","detail":"{readStateIndex:384; appliedIndex:382; }","duration":"198.884158ms","start":"2026-05-27T19:34:55.345719Z","end":"2026-05-27T19:34:55.544603Z","steps":["trace[206600145] 'read index received' (duration: 19.434812ms)","trace[206600145] 'applied index is now lower than readState.Index' (duration: 179.448236ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.545003Z","caller":"traceutil/trace.go:171","msg":"trace[2024149793] transaction","detail":"{read_only:false; response_revision:370; number_of_response:1; }","duration":"196.993176ms","start":"2026-05-27T19:34:55.347998Z","end":"2026-05-27T19:34:55.544991Z","steps":["trace[2024149793] 'process raft request' (duration: 196.476293ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:55.545073Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.329361ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/replicaset-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-05-27T19:34:55.544556Z","caller":"traceutil/trace.go:171","msg":"trace[1946226866] transaction","detail":"{read_only:false; response_revision:369; number_of_response:1; }","duration":"198.744228ms","start":"2026-05-27T19:34:55.345782Z","end":"2026-05-27T19:34:55.544527Z","steps":["trace[1946226866] 'process raft request' (duration: 198.502036ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.545115Z","caller":"traceutil/trace.go:171","msg":"trace[592197762] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/replicaset-controller; range_end:; response_count:1; response_revision:372; }","duration":"199.387891ms","start":"2026-05-27T19:34:55.345712Z","end":"2026-05-27T19:34:55.5451Z","steps":["trace[592197762] 'agreement among raft nodes before linearized reading' (duration: 199.2942ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.547844Z","caller":"traceutil/trace.go:171","msg":"trace[1369431476] transaction","detail":"{read_only:false; response_revision:373; number_of_response:1; }","duration":"178.044377ms","start":"2026-05-27T19:34:55.369778Z","end":"2026-05-27T19:34:55.547822Z","steps":["trace[1369431476] 'process raft request' (duration: 177.922676ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:34:55.757278Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.529851ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-27T19:34:55.757511Z","caller":"traceutil/trace.go:171","msg":"trace[128927713] transaction","detail":"{read_only:false; response_revision:385; number_of_response:1; }","duration":"140.498221ms","start":"2026-05-27T19:34:55.616977Z","end":"2026-05-27T19:34:55.757475Z","steps":["trace[128927713] 'process raft request' (duration: 28.690859ms)","trace[128927713] 'compare' (duration: 111.34125ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.757623Z","caller":"traceutil/trace.go:171","msg":"trace[1459480296] transaction","detail":"{read_only:false; response_revision:386; number_of_response:1; }","duration":"138.63011ms","start":"2026-05-27T19:34:55.618917Z","end":"2026-05-27T19:34:55.757547Z","steps":["trace[1459480296] 'process raft request' (duration: 138.480979ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.757648Z","caller":"traceutil/trace.go:171","msg":"trace[1330325691] transaction","detail":"{read_only:false; response_revision:387; number_of_response:1; }","duration":"138.215667ms","start":"2026-05-27T19:34:55.619378Z","end":"2026-05-27T19:34:55.757593Z","steps":["trace[1330325691] 'process raft request' (duration: 138.069756ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.757889Z","caller":"traceutil/trace.go:171","msg":"trace[724718381] transaction","detail":"{read_only:false; response_revision:388; number_of_response:1; }","duration":"138.367528ms","start":"2026-05-27T19:34:55.61942Z","end":"2026-05-27T19:34:55.757787Z","steps":["trace[724718381] 'process raft request' (duration: 138.085896ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:55.963005Z","caller":"traceutil/trace.go:171","msg":"trace[2015527607] transaction","detail":"{read_only:false; response_revision:390; number_of_response:1; }","duration":"185.803865ms","start":"2026-05-27T19:34:55.777169Z","end":"2026-05-27T19:34:55.962972Z","steps":["trace[2015527607] 'process raft request' (duration: 158.198892ms)","trace[2015527607] 'compare' (duration: 27.398762ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:55.963231Z","caller":"traceutil/trace.go:171","msg":"trace[832343116] linearizableReadLoop","detail":"{readStateIndex:406; appliedIndex:405; }","duration":"178.882282ms","start":"2026-05-27T19:34:55.78433Z","end":"2026-05-27T19:34:55.963213Z","steps":["trace[832343116] 'read index received' (duration: 151.050847ms)","trace[832343116] 'applied index is now lower than readState.Index' (duration: 27.830045ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:34:55.963345Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.994432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-scheduler-instance\" ","response":"range_response_count:1 size:4322"} {"level":"info","ts":"2026-05-27T19:34:55.963379Z","caller":"traceutil/trace.go:171","msg":"trace[1045062158] range","detail":"{range_begin:/registry/pods/kube-system/kube-scheduler-instance; range_end:; response_count:1; response_revision:390; }","duration":"179.077643ms","start":"2026-05-27T19:34:55.784289Z","end":"2026-05-27T19:34:55.963367Z","steps":["trace[1045062158] 'agreement among raft nodes before linearized reading' (duration: 178.999042ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:56.135321Z","caller":"traceutil/trace.go:171","msg":"trace[251998445] transaction","detail":"{read_only:false; response_revision:392; number_of_response:1; }","duration":"163.639184ms","start":"2026-05-27T19:34:55.971656Z","end":"2026-05-27T19:34:56.135295Z","steps":["trace[251998445] 'process raft request' (duration: 120.594984ms)","trace[251998445] 'compare' (duration: 42.860358ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:56.135648Z","caller":"traceutil/trace.go:171","msg":"trace[1947317581] transaction","detail":"{read_only:false; response_revision:393; number_of_response:1; }","duration":"163.589302ms","start":"2026-05-27T19:34:55.972029Z","end":"2026-05-27T19:34:56.135619Z","steps":["trace[1947317581] 'process raft request' (duration: 163.20928ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:56.258714Z","caller":"traceutil/trace.go:171","msg":"trace[1573021264] transaction","detail":"{read_only:false; response_revision:395; number_of_response:1; }","duration":"116.83694ms","start":"2026-05-27T19:34:56.141851Z","end":"2026-05-27T19:34:56.258688Z","steps":["trace[1573021264] 'process raft request' (duration: 106.267154ms)","trace[1573021264] 'compare' (duration: 10.381565ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:34:56.259052Z","caller":"traceutil/trace.go:171","msg":"trace[635705729] transaction","detail":"{read_only:false; response_revision:396; number_of_response:1; }","duration":"116.77493ms","start":"2026-05-27T19:34:56.142236Z","end":"2026-05-27T19:34:56.259011Z","steps":["trace[635705729] 'process raft request' (duration: 116.407288ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:56.259192Z","caller":"traceutil/trace.go:171","msg":"trace[1450296664] transaction","detail":"{read_only:false; response_revision:397; number_of_response:1; }","duration":"116.82177ms","start":"2026-05-27T19:34:56.142338Z","end":"2026-05-27T19:34:56.25916Z","steps":["trace[1450296664] 'process raft request' (duration: 116.541338ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:56.259459Z","caller":"traceutil/trace.go:171","msg":"trace[1941886802] transaction","detail":"{read_only:false; response_revision:398; number_of_response:1; }","duration":"112.297521ms","start":"2026-05-27T19:34:56.147149Z","end":"2026-05-27T19:34:56.259446Z","steps":["trace[1941886802] 'process raft request' (duration: 111.954439ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:34:56.259454Z","caller":"traceutil/trace.go:171","msg":"trace[2001903661] linearizableReadLoop","detail":"{readStateIndex:415; appliedIndex:411; }","duration":"110.852472ms","start":"2026-05-27T19:34:56.148485Z","end":"2026-05-27T19:34:56.259338Z","steps":["trace[2001903661] 'read index received' (duration: 37.530984ms)","trace[2001903661] 'applied index is now lower than readState.Index' (duration: 73.319548ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:34:56.259584Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.074253ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:34:56.259721Z","caller":"traceutil/trace.go:171","msg":"trace[609949284] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:398; }","duration":"111.222044ms","start":"2026-05-27T19:34:56.14848Z","end":"2026-05-27T19:34:56.259702Z","steps":["trace[609949284] 'agreement among raft nodes before linearized reading' (duration: 111.041193ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:15.964402Z","caller":"traceutil/trace.go:171","msg":"trace[1854331962] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"107.043601ms","start":"2026-05-27T19:35:15.857341Z","end":"2026-05-27T19:35:15.964385Z","steps":["trace[1854331962] 'process raft request' (duration: 106.928795ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:22.30143Z","caller":"traceutil/trace.go:171","msg":"trace[1754070134] linearizableReadLoop","detail":"{readStateIndex:513; appliedIndex:511; }","duration":"165.117962ms","start":"2026-05-27T19:35:22.136288Z","end":"2026-05-27T19:35:22.301406Z","steps":["trace[1754070134] 'read index received' (duration: 97.535115ms)","trace[1754070134] 'applied index is now lower than readState.Index' (duration: 67.581897ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:35:22.301477Z","caller":"traceutil/trace.go:171","msg":"trace[1389308467] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"173.283267ms","start":"2026-05-27T19:35:22.128169Z","end":"2026-05-27T19:35:22.301452Z","steps":["trace[1389308467] 'process raft request' (duration: 173.118449ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:22.302188Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.870069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" ","response":"range_response_count:3 size:12673"} {"level":"info","ts":"2026-05-27T19:35:22.302266Z","caller":"traceutil/trace.go:171","msg":"trace[714742153] range","detail":"{range_begin:/registry/secrets/kube-system/; range_end:/registry/secrets/kube-system0; response_count:3; response_revision:490; }","duration":"165.991045ms","start":"2026-05-27T19:35:22.136253Z","end":"2026-05-27T19:35:22.302244Z","steps":["trace[714742153] 'agreement among raft nodes before linearized reading' (duration: 165.246889ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:25.898445Z","caller":"traceutil/trace.go:171","msg":"trace[1391830135] transaction","detail":"{read_only:false; response_revision:561; number_of_response:1; }","duration":"373.167421ms","start":"2026-05-27T19:35:25.525262Z","end":"2026-05-27T19:35:25.89843Z","steps":["trace[1391830135] 'process raft request' (duration: 373.034165ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:25.898449Z","caller":"traceutil/trace.go:171","msg":"trace[1969771620] transaction","detail":"{read_only:false; response_revision:560; number_of_response:1; }","duration":"382.915899ms","start":"2026-05-27T19:35:25.51546Z","end":"2026-05-27T19:35:25.898376Z","steps":["trace[1969771620] 'process raft request' (duration: 376.157665ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:25.89857Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:25.525241Z","time spent":"373.271316ms","remote":"127.0.0.1:34298","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":23057,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:35:25.898571Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:25.515443Z","time spent":"383.077276ms","remote":"127.0.0.1:34298","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":7693,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:25.898674Z","caller":"traceutil/trace.go:171","msg":"trace[1042281322] transaction","detail":"{read_only:false; response_revision:562; number_of_response:1; }","duration":"351.147266ms","start":"2026-05-27T19:35:25.547516Z","end":"2026-05-27T19:35:25.898663Z","steps":["trace[1042281322] 'process raft request' (duration: 350.858002ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:25.898653Z","caller":"traceutil/trace.go:171","msg":"trace[1260930980] transaction","detail":"{read_only:false; response_revision:564; number_of_response:1; }","duration":"249.59897ms","start":"2026-05-27T19:35:25.649027Z","end":"2026-05-27T19:35:25.898626Z","steps":["trace[1260930980] 'process raft request' (duration: 249.535917ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:25.898741Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:25.547497Z","time spent":"351.214159ms","remote":"127.0.0.1:34298","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79947,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:25.898766Z","caller":"traceutil/trace.go:171","msg":"trace[1858443180] transaction","detail":"{read_only:false; response_revision:563; number_of_response:1; }","duration":"344.686247ms","start":"2026-05-27T19:35:25.554074Z","end":"2026-05-27T19:35:25.89876Z","steps":["trace[1858443180] 'process raft request' (duration: 344.404303ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:25.898796Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:25.55405Z","time spent":"344.729659ms","remote":"127.0.0.1:34298","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":58844,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:35:32.326576Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.091048029s","expected-duration":"1s"} {"level":"info","ts":"2026-05-27T19:35:32.327567Z","caller":"traceutil/trace.go:171","msg":"trace[1896168431] transaction","detail":"{read_only:false; response_revision:637; number_of_response:1; }","duration":"1.094384538s","start":"2026-05-27T19:35:31.233154Z","end":"2026-05-27T19:35:32.327539Z","steps":["trace[1896168431] 'process raft request' (duration: 1.093851104s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.32771Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:31.23312Z","time spent":"1.094516913s","remote":"127.0.0.1:34336","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036261,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:32.826748Z","caller":"traceutil/trace.go:171","msg":"trace[761997109] linearizableReadLoop","detail":"{readStateIndex:664; appliedIndex:662; }","duration":"961.166181ms","start":"2026-05-27T19:35:31.865548Z","end":"2026-05-27T19:35:32.826714Z","steps":["trace[761997109] 'read index received' (duration: 461.269229ms)","trace[761997109] 'applied index is now lower than readState.Index' (duration: 499.893852ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:35:32.826875Z","caller":"traceutil/trace.go:171","msg":"trace[368573875] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"345.277628ms","start":"2026-05-27T19:35:32.481575Z","end":"2026-05-27T19:35:32.826852Z","steps":["trace[368573875] 'process raft request' (duration: 345.209415ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827001Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"495.09873ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-27T19:35:32.827016Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.481565Z","time spent":"345.377603ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:35:32.827009Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"961.442623ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-8g6ms\" ","response":"range_response_count:1 size:16961"} {"level":"info","ts":"2026-05-27T19:35:32.827046Z","caller":"traceutil/trace.go:171","msg":"trace[259392348] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:639; }","duration":"495.188414ms","start":"2026-05-27T19:35:32.331846Z","end":"2026-05-27T19:35:32.827034Z","steps":["trace[259392348] 'agreement among raft nodes before linearized reading' (duration: 495.019347ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827081Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.33183Z","time spent":"495.243297ms","remote":"127.0.0.1:34264","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-27T19:35:32.827082Z","caller":"traceutil/trace.go:171","msg":"trace[863313395] range","detail":"{range_begin:/registry/pods/kube-system/cilium-8g6ms; range_end:; response_count:1; response_revision:639; }","duration":"961.548758ms","start":"2026-05-27T19:35:31.865507Z","end":"2026-05-27T19:35:32.827056Z","steps":["trace[863313395] 'agreement among raft nodes before linearized reading' (duration: 961.305737ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827134Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:31.86549Z","time spent":"961.634652ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16983,"request content":"key:\"/registry/pods/kube-system/cilium-8g6ms\" "} {"level":"info","ts":"2026-05-27T19:35:32.827065Z","caller":"traceutil/trace.go:171","msg":"trace[1546559785] transaction","detail":"{read_only:false; response_revision:638; number_of_response:1; }","duration":"419.64126ms","start":"2026-05-27T19:35:32.407361Z","end":"2026-05-27T19:35:32.827002Z","steps":["trace[1546559785] 'process raft request' (duration: 419.261963ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827346Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"413.208376ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"warn","ts":"2026-05-27T19:35:32.827325Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"370.131076ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"warn","ts":"2026-05-27T19:35:32.827365Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.407342Z","time spent":"419.984235ms","remote":"127.0.0.1:34558","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1087,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T19:35:32.827411Z","caller":"traceutil/trace.go:171","msg":"trace[15422699] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:639; }","duration":"370.255461ms","start":"2026-05-27T19:35:32.457134Z","end":"2026-05-27T19:35:32.827389Z","steps":["trace[15422699] 'agreement among raft nodes before linearized reading' (duration: 369.992419ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.82745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"365.368075ms","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-05-27T19:35:32.827466Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.457117Z","time spent":"370.340245ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-27T19:35:32.827349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"365.73016ms","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-05-27T19:35:32.827503Z","caller":"traceutil/trace.go:171","msg":"trace[478502017] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:639; }","duration":"365.435019ms","start":"2026-05-27T19:35:32.462051Z","end":"2026-05-27T19:35:32.827486Z","steps":["trace[478502017] 'agreement among raft nodes before linearized reading' (duration: 365.333413ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:32.827539Z","caller":"traceutil/trace.go:171","msg":"trace[1979653847] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:639; }","duration":"365.981973ms","start":"2026-05-27T19:35:32.461541Z","end":"2026-05-27T19:35:32.827523Z","steps":["trace[1979653847] 'agreement among raft nodes before linearized reading' (duration: 365.497ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827605Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.46153Z","time spent":"366.047186ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-05-27T19:35:32.827384Z","caller":"traceutil/trace.go:171","msg":"trace[1408144948] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:639; }","duration":"413.28373ms","start":"2026-05-27T19:35:32.414091Z","end":"2026-05-27T19:35:32.827375Z","steps":["trace[1408144948] 'agreement among raft nodes before linearized reading' (duration: 413.165635ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:32.827699Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.414067Z","time spent":"413.618516ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-05-27T19:35:32.827547Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.462039Z","time spent":"365.500952ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-05-27T19:35:34.405661Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"734.175269ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T19:35:34.405961Z","caller":"traceutil/trace.go:171","msg":"trace[1556162491] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"1.566010802s","start":"2026-05-27T19:35:32.839932Z","end":"2026-05-27T19:35:34.405943Z","steps":["trace[1556162491] 'process raft request' (duration: 1.565953419s)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:34.405964Z","caller":"traceutil/trace.go:171","msg":"trace[811422132] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"1.573605347s","start":"2026-05-27T19:35:32.832319Z","end":"2026-05-27T19:35:34.405925Z","steps":["trace[811422132] 'process raft request' (duration: 839.072003ms)","trace[811422132] 'compare' (duration: 733.837844ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:35:34.406037Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.839922Z","time spent":"1.566084236s","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17130,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:35:34.406117Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.832293Z","time spent":"1.573739764s","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:34.406233Z","caller":"traceutil/trace.go:171","msg":"trace[836030874] transaction","detail":"{read_only:false; response_revision:642; number_of_response:1; }","duration":"1.573785415s","start":"2026-05-27T19:35:32.832436Z","end":"2026-05-27T19:35:34.406222Z","steps":["trace[836030874] 'process raft request' (duration: 1.573326725s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:34.406332Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.832424Z","time spent":"1.573862539s","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:34.406622Z","caller":"traceutil/trace.go:171","msg":"trace[1333870344] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"1.573549004s","start":"2026-05-27T19:35:32.833039Z","end":"2026-05-27T19:35:34.406588Z","steps":["trace[1333870344] 'process raft request' (duration: 1.572802683s)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:34.40667Z","caller":"traceutil/trace.go:171","msg":"trace[90425767] linearizableReadLoop","detail":"{readStateIndex:670; appliedIndex:666; }","duration":"1.568393227s","start":"2026-05-27T19:35:32.838246Z","end":"2026-05-27T19:35:34.40664Z","steps":["trace[90425767] 'read index received' (duration: 241.751µs)","trace[90425767] 'applied index is now lower than readState.Index' (duration: 1.568150036s)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:35:34.406806Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.833022Z","time spent":"1.573698241s","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:35:34.406804Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.568547893s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:35:34.406867Z","caller":"traceutil/trace.go:171","msg":"trace[1585647799] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system; range_end:; response_count:0; response_revision:644; }","duration":"1.568629047s","start":"2026-05-27T19:35:32.83822Z","end":"2026-05-27T19:35:34.406849Z","steps":["trace[1585647799] 'agreement among raft nodes before linearized reading' (duration: 1.568542593s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:34.406908Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:32.838209Z","time spent":"1.56868907s","remote":"127.0.0.1:34704","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":0,"response size":27,"request content":"key:\"/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system\" "} {"level":"warn","ts":"2026-05-27T19:35:36.357862Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.382998ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:35:36.358148Z","caller":"traceutil/trace.go:171","msg":"trace[1983848932] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io; range_end:; response_count:0; response_revision:684; }","duration":"200.700921ms","start":"2026-05-27T19:35:36.157425Z","end":"2026-05-27T19:35:36.358126Z","steps":["trace[1983848932] 'range keys from in-memory index tree' (duration: 200.314144ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:39.237309Z","caller":"traceutil/trace.go:171","msg":"trace[214684976] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"172.242569ms","start":"2026-05-27T19:35:39.065049Z","end":"2026-05-27T19:35:39.237291Z","steps":["trace[214684976] 'process raft request' (duration: 172.024959ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:49.467199Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":10211804862192887189,"retry-timeout":"500ms"} {"level":"info","ts":"2026-05-27T19:35:49.747404Z","caller":"traceutil/trace.go:171","msg":"trace[1167300470] linearizableReadLoop","detail":"{readStateIndex:837; appliedIndex:836; }","duration":"780.367664ms","start":"2026-05-27T19:35:48.96701Z","end":"2026-05-27T19:35:49.747378Z","steps":["trace[1167300470] 'read index received' (duration: 780.146706ms)","trace[1167300470] 'applied index is now lower than readState.Index' (duration: 219.707µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:35:49.747551Z","caller":"traceutil/trace.go:171","msg":"trace[1505217266] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"840.444552ms","start":"2026-05-27T19:35:48.907082Z","end":"2026-05-27T19:35:49.747526Z","steps":["trace[1505217266] 'process raft request' (duration: 840.151441ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:49.74765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"780.627553ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-vbs92\" ","response":"range_response_count:1 size:3964"} {"level":"info","ts":"2026-05-27T19:35:49.747715Z","caller":"traceutil/trace.go:171","msg":"trace[2101707785] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-vbs92; range_end:; response_count:1; response_revision:805; }","duration":"780.754978ms","start":"2026-05-27T19:35:48.966939Z","end":"2026-05-27T19:35:49.747694Z","steps":["trace[2101707785] 'agreement among raft nodes before linearized reading' (duration: 780.549801ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:35:49.747767Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:48.966914Z","time spent":"780.840591ms","remote":"127.0.0.1:34410","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":1,"response size":3986,"request content":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-vbs92\" "} {"level":"warn","ts":"2026-05-27T19:35:49.747836Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:35:48.907061Z","time spent":"840.552395ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:35:50.005943Z","caller":"traceutil/trace.go:171","msg":"trace[203183412] linearizableReadLoop","detail":"{readStateIndex:838; appliedIndex:837; }","duration":"181.466854ms","start":"2026-05-27T19:35:49.824448Z","end":"2026-05-27T19:35:50.005915Z","steps":["trace[203183412] 'read index received' (duration: 181.236795ms)","trace[203183412] 'applied index is now lower than readState.Index' (duration: 228.689µs)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:35:50.006144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.674831ms","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-05-27T19:35:50.006175Z","caller":"traceutil/trace.go:171","msg":"trace[1415384621] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:806; }","duration":"181.753344ms","start":"2026-05-27T19:35:49.824412Z","end":"2026-05-27T19:35:50.006166Z","steps":["trace[1415384621] 'agreement among raft nodes before linearized reading' (duration: 181.607889ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:35:50.006271Z","caller":"traceutil/trace.go:171","msg":"trace[48305802] transaction","detail":"{read_only:false; response_revision:806; number_of_response:1; }","duration":"251.371786ms","start":"2026-05-27T19:35:49.754872Z","end":"2026-05-27T19:35:50.006244Z","steps":["trace[48305802] 'process raft request' (duration: 250.889417ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:36:36.311279Z","caller":"traceutil/trace.go:171","msg":"trace[1196382981] linearizableReadLoop","detail":"{readStateIndex:1130; appliedIndex:1129; }","duration":"368.412856ms","start":"2026-05-27T19:36:35.942844Z","end":"2026-05-27T19:36:36.311257Z","steps":["trace[1196382981] 'read index received' (duration: 368.387755ms)","trace[1196382981] 'applied index is now lower than readState.Index' (duration: 24.211µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:36:36.311403Z","caller":"traceutil/trace.go:171","msg":"trace[1837319920] transaction","detail":"{read_only:false; response_revision:1088; number_of_response:1; }","duration":"406.202521ms","start":"2026-05-27T19:36:35.905189Z","end":"2026-05-27T19:36:36.311392Z","steps":["trace[1837319920] 'process raft request' (duration: 405.943175ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:36.31155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:35.905166Z","time spent":"406.279092ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:36:36.311629Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"368.764904ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-05-27T19:36:36.311713Z","caller":"traceutil/trace.go:171","msg":"trace[2132662115] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1088; }","duration":"368.896997ms","start":"2026-05-27T19:36:35.942796Z","end":"2026-05-27T19:36:36.311693Z","steps":["trace[2132662115] 'agreement among raft nodes before linearized reading' (duration: 368.687652ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:36.311748Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:35.942772Z","time spent":"368.966338ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-27T19:36:36.543906Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.032227ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T19:36:36.544018Z","caller":"traceutil/trace.go:171","msg":"trace[1075589591] transaction","detail":"{read_only:false; response_revision:1089; number_of_response:1; }","duration":"228.983585ms","start":"2026-05-27T19:36:36.315015Z","end":"2026-05-27T19:36:36.543998Z","steps":["trace[1075589591] 'process raft request' (duration: 87.763264ms)","trace[1075589591] 'compare' (duration: 140.805601ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:36:36.569634Z","caller":"traceutil/trace.go:171","msg":"trace[651103603] linearizableReadLoop","detail":"{readStateIndex:1132; appliedIndex:1130; }","duration":"240.371353ms","start":"2026-05-27T19:36:36.329248Z","end":"2026-05-27T19:36:36.569619Z","steps":["trace[651103603] 'read index received' (duration: 73.54099ms)","trace[651103603] 'applied index is now lower than readState.Index' (duration: 166.829713ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:36:36.569717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.463075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T19:36:36.569702Z","caller":"traceutil/trace.go:171","msg":"trace[487671385] transaction","detail":"{read_only:false; response_revision:1090; number_of_response:1; }","duration":"254.240419ms","start":"2026-05-27T19:36:36.315427Z","end":"2026-05-27T19:36:36.569668Z","steps":["trace[487671385] 'process raft request' (duration: 254.100585ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:36:36.569744Z","caller":"traceutil/trace.go:171","msg":"trace[1894892354] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1090; }","duration":"240.541617ms","start":"2026-05-27T19:36:36.329196Z","end":"2026-05-27T19:36:36.569738Z","steps":["trace[1894892354] 'agreement among raft nodes before linearized reading' (duration: 240.485916ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:37.252365Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.500522ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T19:36:37.252558Z","caller":"traceutil/trace.go:171","msg":"trace[1070594442] linearizableReadLoop","detail":"{readStateIndex:1137; appliedIndex:1133; }","duration":"287.598679ms","start":"2026-05-27T19:36:36.96495Z","end":"2026-05-27T19:36:37.252548Z","steps":["trace[1070594442] 'read index received' (duration: 85.606266ms)","trace[1070594442] 'applied index is now lower than readState.Index' (duration: 201.991953ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:36:37.252605Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.65453ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-27T19:36:37.25262Z","caller":"traceutil/trace.go:171","msg":"trace[2086649130] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1094; }","duration":"287.705781ms","start":"2026-05-27T19:36:36.964908Z","end":"2026-05-27T19:36:37.252614Z","steps":["trace[2086649130] 'agreement among raft nodes before linearized reading' (duration: 287.669ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:36:37.252605Z","caller":"traceutil/trace.go:171","msg":"trace[1364420727] transaction","detail":"{read_only:false; response_revision:1094; number_of_response:1; }","duration":"448.283768ms","start":"2026-05-27T19:36:36.804299Z","end":"2026-05-27T19:36:37.252583Z","steps":["trace[1364420727] 'process raft request' (duration: 448.225396ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:36:37.252607Z","caller":"traceutil/trace.go:171","msg":"trace[1800045340] transaction","detail":"{read_only:false; response_revision:1092; number_of_response:1; }","duration":"474.195427ms","start":"2026-05-27T19:36:36.778388Z","end":"2026-05-27T19:36:37.252584Z","steps":["trace[1800045340] 'process raft request' (duration: 474.079854ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:36:37.252605Z","caller":"traceutil/trace.go:171","msg":"trace[941889260] transaction","detail":"{read_only:false; response_revision:1093; number_of_response:1; }","duration":"473.975321ms","start":"2026-05-27T19:36:36.778601Z","end":"2026-05-27T19:36:37.252576Z","steps":["trace[941889260] 'process raft request' (duration: 473.90253ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:37.252737Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:36.804286Z","time spent":"448.380089ms","remote":"127.0.0.1:34292","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":118,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:36:37.252743Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:36.778587Z","time spent":"474.104005ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T19:36:37.252757Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:36.778364Z","time spent":"474.30703ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:36:37.252608Z","caller":"traceutil/trace.go:171","msg":"trace[1349837244] transaction","detail":"{read_only:false; response_revision:1091; number_of_response:1; }","duration":"474.496383ms","start":"2026-05-27T19:36:36.77808Z","end":"2026-05-27T19:36:37.252576Z","steps":["trace[1349837244] 'process raft request' (duration: 272.464719ms)","trace[1349837244] 'compare' (duration: 201.41017ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T19:36:37.252858Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T19:36:36.778063Z","time spent":"474.77649ms","remote":"127.0.0.1:34484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T19:36:47.522672Z","caller":"traceutil/trace.go:171","msg":"trace[388077581] linearizableReadLoop","detail":"{readStateIndex:1170; appliedIndex:1169; }","duration":"225.472187ms","start":"2026-05-27T19:36:47.297171Z","end":"2026-05-27T19:36:47.522643Z","steps":["trace[388077581] 'read index received' (duration: 225.206462ms)","trace[388077581] 'applied index is now lower than readState.Index' (duration: 264.465µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:36:47.52272Z","caller":"traceutil/trace.go:171","msg":"trace[1982627239] transaction","detail":"{read_only:false; response_revision:1125; number_of_response:1; }","duration":"227.637924ms","start":"2026-05-27T19:36:47.295047Z","end":"2026-05-27T19:36:47.522685Z","steps":["trace[1982627239] 'process raft request' (duration: 227.44521ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:47.523009Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.249952ms","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-05-27T19:36:47.523089Z","caller":"traceutil/trace.go:171","msg":"trace[259663789] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1125; }","duration":"225.377555ms","start":"2026-05-27T19:36:47.297689Z","end":"2026-05-27T19:36:47.523067Z","steps":["trace[259663789] 'agreement among raft nodes before linearized reading' (duration: 225.14117ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:36:47.523556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.377996ms","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-05-27T19:36:47.523625Z","caller":"traceutil/trace.go:171","msg":"trace[1590854141] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1125; }","duration":"226.455187ms","start":"2026-05-27T19:36:47.297147Z","end":"2026-05-27T19:36:47.523602Z","steps":["trace[1590854141] 'agreement among raft nodes before linearized reading' (duration: 225.62283ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T19:37:41.958575Z","caller":"traceutil/trace.go:171","msg":"trace[968818380] linearizableReadLoop","detail":"{readStateIndex:1398; appliedIndex:1397; }","duration":"144.902618ms","start":"2026-05-27T19:37:41.813649Z","end":"2026-05-27T19:37:41.958552Z","steps":["trace[968818380] 'read index received' (duration: 144.668154ms)","trace[968818380] 'applied index is now lower than readState.Index' (duration: 233.324µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T19:37:41.958727Z","caller":"traceutil/trace.go:171","msg":"trace[2038581382] transaction","detail":"{read_only:false; response_revision:1341; number_of_response:1; }","duration":"145.048871ms","start":"2026-05-27T19:37:41.813613Z","end":"2026-05-27T19:37:41.958662Z","steps":["trace[2038581382] 'process raft request' (duration: 144.768026ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T19:37:41.958824Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.163372ms","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-05-27T19:37:41.958878Z","caller":"traceutil/trace.go:171","msg":"trace[2129094831] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1341; }","duration":"145.245384ms","start":"2026-05-27T19:37:41.813608Z","end":"2026-05-27T19:37:41.958853Z","steps":["trace[2129094831] 'agreement among raft nodes before linearized reading' (duration: 145.093831ms)"],"step_count":1}