{"level":"warn","ts":"2026-05-27T05:58:27.079933Z","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-27T05:58:27.080088Z","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-05-27T05:58:27.080187Z","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-27T05:58:27.080225Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.65:2380"]} {"level":"info","ts":"2026-05-27T05:58:27.080268Z","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-27T05:58:27.081125Z","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-05-27T05:58:27.081292Z","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-05-27T05:58:27.086591Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"5.027319ms"} {"level":"info","ts":"2026-05-27T05:58:27.099176Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"cf8c3a138c9a77a2","cluster-id":"c278183e1f634dff"} {"level":"info","ts":"2026-05-27T05:58:27.099295Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=()"} {"level":"info","ts":"2026-05-27T05:58:27.099336Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 0"} {"level":"info","ts":"2026-05-27T05:58:27.099377Z","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-05-27T05:58:27.099401Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 1"} {"level":"info","ts":"2026-05-27T05:58:27.099464Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"} {"level":"warn","ts":"2026-05-27T05:58:27.107844Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-27T05:58:27.109204Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-27T05:58:27.111537Z","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-27T05:58:27.113597Z","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-05-27T05:58:27.114597Z","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-27T05:58:27.114703Z","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-27T05:58:27.114718Z","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-27T05:58:27.114944Z","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-05-27T05:58:27.115609Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"} {"level":"info","ts":"2026-05-27T05:58:27.116236Z","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-05-27T05:58:27.118481Z","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-27T05:58:27.118728Z","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-05-27T05:58:27.118775Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-27T05:58:27.118858Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.65:2380"} {"level":"info","ts":"2026-05-27T05:58:27.118881Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.65:2380"} {"level":"info","ts":"2026-05-27T05:58:27.602422Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 is starting a new election at term 1"} {"level":"info","ts":"2026-05-27T05:58:27.603855Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became pre-candidate at term 1"} {"level":"info","ts":"2026-05-27T05:58:27.603888Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgPreVoteResp from cf8c3a138c9a77a2 at term 1"} {"level":"info","ts":"2026-05-27T05:58:27.6039Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became candidate at term 2"} {"level":"info","ts":"2026-05-27T05:58:27.603908Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgVoteResp from cf8c3a138c9a77a2 at term 2"} {"level":"info","ts":"2026-05-27T05:58:27.603919Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became leader at term 2"} {"level":"info","ts":"2026-05-27T05:58:27.603927Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: cf8c3a138c9a77a2 elected leader cf8c3a138c9a77a2 at term 2"} {"level":"info","ts":"2026-05-27T05:58:27.610735Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T05:58:27.610855Z","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-05-27T05:58:27.611508Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-27T05:58:27.611916Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-27T05:58:27.612499Z","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-05-27T05:58:27.612745Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T05:58:27.612842Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-27T05:58:27.614436Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-27T05:58:27.614462Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-27T05:58:27.616275Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-27T05:58:27.617091Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.65:2379"} {"level":"info","ts":"2026-05-27T05:58:29.247618Z","caller":"traceutil/trace.go:171","msg":"trace[1975540918] transaction","detail":"{read_only:false; response_revision:2; number_of_response:1; }","duration":"419.123587ms","start":"2026-05-27T05:58:28.828467Z","end":"2026-05-27T05:58:29.24759Z","steps":["trace[1975540918] 'process raft request' (duration: 418.856179ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:29.248342Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.828452Z","time spent":"419.244621ms","remote":"127.0.0.1:52318","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":105,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:58:30.006199Z","caller":"traceutil/trace.go:171","msg":"trace[654365965] linearizableReadLoop","detail":"{readStateIndex:6; appliedIndex:4; }","duration":"1.173863259s","start":"2026-05-27T05:58:28.832311Z","end":"2026-05-27T05:58:30.006174Z","steps":["trace[654365965] 'read index received' (duration: 415.03511ms)","trace[654365965] 'applied index is now lower than readState.Index' (duration: 758.827059ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:30.006445Z","caller":"traceutil/trace.go:171","msg":"trace[1277938738] transaction","detail":"{read_only:false; response_revision:3; number_of_response:1; }","duration":"1.177725369s","start":"2026-05-27T05:58:28.828678Z","end":"2026-05-27T05:58:30.006404Z","steps":["trace[1277938738] 'process raft request' (duration: 1.176896544s)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.00662Z","caller":"traceutil/trace.go:171","msg":"trace[1569908450] transaction","detail":"{read_only:false; response_revision:5; number_of_response:1; }","duration":"1.125638297s","start":"2026-05-27T05:58:28.880965Z","end":"2026-05-27T05:58:30.006603Z","steps":["trace[1569908450] 'process raft request' (duration: 1.124908515s)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.006601Z","caller":"traceutil/trace.go:171","msg":"trace[1665505543] transaction","detail":"{read_only:false; response_revision:6; number_of_response:1; }","duration":"1.125578705s","start":"2026-05-27T05:58:28.880981Z","end":"2026-05-27T05:58:30.00656Z","steps":["trace[1665505543] 'process raft request' (duration: 1.124945985s)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.00669Z","caller":"traceutil/trace.go:171","msg":"trace[561767063] transaction","detail":"{read_only:false; response_revision:7; number_of_response:1; }","duration":"1.125587946s","start":"2026-05-27T05:58:28.881091Z","end":"2026-05-27T05:58:30.006679Z","steps":["trace[561767063] 'process raft request' (duration: 1.124861253s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.006752Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.88095Z","time spent":"1.1257283s","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":883,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.006768Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.828668Z","time spent":"1.177934256s","remote":"127.0.0.1:52308","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":100,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:58:30.006787Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.881084Z","time spent":"1.125661508s","remote":"127.0.0.1:52694","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":698,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.006808Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.88097Z","time spent":"1.125735019s","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":920,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.006639Z","caller":"traceutil/trace.go:171","msg":"trace[824501466] transaction","detail":"{read_only:false; response_revision:10; number_of_response:1; }","duration":"1.090515465s","start":"2026-05-27T05:58:28.916107Z","end":"2026-05-27T05:58:30.006623Z","steps":["trace[824501466] 'process raft request' (duration: 1.089945487s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.006991Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.916091Z","time spent":"1.090877966s","remote":"127.0.0.1:52500","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":849,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.007004Z","caller":"traceutil/trace.go:171","msg":"trace[1793890318] transaction","detail":"{read_only:false; response_revision:8; number_of_response:1; }","duration":"1.125829413s","start":"2026-05-27T05:58:28.88116Z","end":"2026-05-27T05:58:30.006989Z","steps":["trace[1793890318] 'process raft request' (duration: 1.124840403s)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.006363Z","caller":"traceutil/trace.go:171","msg":"trace[2083203462] transaction","detail":"{read_only:false; response_revision:4; number_of_response:1; }","duration":"1.125683019s","start":"2026-05-27T05:58:28.880638Z","end":"2026-05-27T05:58:30.006321Z","steps":["trace[2083203462] 'process raft request' (duration: 1.125189983s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.007445Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.445811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-05-27T05:58:30.007462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.034095126s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-05-27T05:58:30.007492Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.880622Z","time spent":"1.126848784s","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":992,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.007506Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.129328512s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.00751Z","caller":"traceutil/trace.go:171","msg":"trace[746818805] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:11; }","duration":"228.527214ms","start":"2026-05-27T05:58:29.778962Z","end":"2026-05-27T05:58:30.007489Z","steps":["trace[746818805] 'agreement among raft nodes before linearized reading' (duration: 228.41709ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.007538Z","caller":"traceutil/trace.go:171","msg":"trace[2065438726] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"1.129379424s","start":"2026-05-27T05:58:28.878147Z","end":"2026-05-27T05:58:30.007526Z","steps":["trace[2065438726] 'agreement among raft nodes before linearized reading' (duration: 1.129346213s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.007569Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.878127Z","time spent":"1.129437126s","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":28,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-27T05:58:30.007098Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.881151Z","time spent":"1.125898365s","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.007141Z","caller":"traceutil/trace.go:171","msg":"trace[541325876] transaction","detail":"{read_only:false; response_revision:9; number_of_response:1; }","duration":"1.125987017s","start":"2026-05-27T05:58:28.881143Z","end":"2026-05-27T05:58:30.00713Z","steps":["trace[541325876] 'process raft request' (duration: 1.124886764s)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.007431Z","caller":"traceutil/trace.go:171","msg":"trace[151358361] transaction","detail":"{read_only:false; response_revision:11; number_of_response:1; }","duration":"1.085961351s","start":"2026-05-27T05:58:28.920932Z","end":"2026-05-27T05:58:30.006894Z","steps":["trace[151358361] 'process raft request' (duration: 1.085180547s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.008816Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.920916Z","time spent":"1.087858291s","remote":"127.0.0.1:52406","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3158,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.007477Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.129237009s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-05-27T05:58:30.007743Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.881117Z","time spent":"1.126527495s","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":971,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.00733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.07506663s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.009683Z","caller":"traceutil/trace.go:171","msg":"trace[1220700753] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"1.077496995s","start":"2026-05-27T05:58:28.932165Z","end":"2026-05-27T05:58:30.009662Z","steps":["trace[1220700753] 'agreement among raft nodes before linearized reading' (duration: 1.07506657s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.009754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.932153Z","time spent":"1.077571158s","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":28,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-27T05:58:30.00735Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.090565386s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.010199Z","caller":"traceutil/trace.go:171","msg":"trace[142799950] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"1.093343963s","start":"2026-05-27T05:58:28.916778Z","end":"2026-05-27T05:58:30.010122Z","steps":["trace[142799950] 'agreement among raft nodes before linearized reading' (duration: 1.090554816s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.01028Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.916756Z","time spent":"1.093500578s","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":28,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-27T05:58:30.007354Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.175042725s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3170"} {"level":"info","ts":"2026-05-27T05:58:30.010547Z","caller":"traceutil/trace.go:171","msg":"trace[936585847] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:11; }","duration":"1.178229985s","start":"2026-05-27T05:58:28.832265Z","end":"2026-05-27T05:58:30.010495Z","steps":["trace[936585847] 'agreement among raft nodes before linearized reading' (duration: 1.174706715s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.010633Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.832249Z","time spent":"1.178353868s","remote":"127.0.0.1:52406","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":3194,"request content":"key:\"/registry/minions/instance\" "} {"level":"warn","ts":"2026-05-27T05:58:30.007399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.125847583s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.011161Z","caller":"traceutil/trace.go:171","msg":"trace[1553865622] range","detail":"{range_begin:/registry/resourcequotas/kube-system/; range_end:/registry/resourcequotas/kube-system0; response_count:0; response_revision:11; }","duration":"1.129187277s","start":"2026-05-27T05:58:28.881493Z","end":"2026-05-27T05:58:30.01068Z","steps":["trace[1553865622] 'agreement among raft nodes before linearized reading' (duration: 1.125878843s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.011248Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.881473Z","time spent":"1.129747324s","remote":"127.0.0.1:52330","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":0,"response size":28,"request content":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" "} {"level":"warn","ts":"2026-05-27T05:58:30.007445Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.129027463s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.65\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.011416Z","caller":"traceutil/trace.go:171","msg":"trace[1965131474] range","detail":"{range_begin:/registry/masterleases/199.204.45.65; range_end:; response_count:0; response_revision:11; }","duration":"1.132998037s","start":"2026-05-27T05:58:28.878399Z","end":"2026-05-27T05:58:30.011397Z","steps":["trace[1965131474] 'agreement among raft nodes before linearized reading' (duration: 1.129021972s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.01148Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.878392Z","time spent":"1.133072529s","remote":"127.0.0.1:52286","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":0,"response size":28,"request content":"key:\"/registry/masterleases/199.204.45.65\" "} {"level":"warn","ts":"2026-05-27T05:58:30.007428Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.533333ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses/system-node-critical\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.011649Z","caller":"traceutil/trace.go:171","msg":"trace[1040558355] range","detail":"{range_begin:/registry/priorityclasses/system-node-critical; range_end:; response_count:0; response_revision:11; }","duration":"232.797506ms","start":"2026-05-27T05:58:29.778841Z","end":"2026-05-27T05:58:30.011639Z","steps":["trace[1040558355] 'agreement among raft nodes before linearized reading' (duration: 228.526653ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.007268Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.174914421s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.011739Z","caller":"traceutil/trace.go:171","msg":"trace[1615948132] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:0; response_revision:11; }","duration":"1.179402321s","start":"2026-05-27T05:58:28.83232Z","end":"2026-05-27T05:58:30.011722Z","steps":["trace[1615948132] 'agreement among raft nodes before linearized reading' (duration: 1.174845739s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.011801Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.832309Z","time spent":"1.179473973s","remote":"127.0.0.1:52618","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":28,"request content":"key:\"/registry/csinodes/instance\" "} {"level":"info","ts":"2026-05-27T05:58:30.00796Z","caller":"traceutil/trace.go:171","msg":"trace[265547066] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"1.034193129s","start":"2026-05-27T05:58:28.973309Z","end":"2026-05-27T05:58:30.007502Z","steps":["trace[265547066] 'agreement among raft nodes before linearized reading' (duration: 1.034097096s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.01194Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.973297Z","time spent":"1.038624727s","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":28,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"info","ts":"2026-05-27T05:58:30.014028Z","caller":"traceutil/trace.go:171","msg":"trace[1502962439] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"1.131012044s","start":"2026-05-27T05:58:28.878232Z","end":"2026-05-27T05:58:30.009244Z","steps":["trace[1502962439] 'agreement among raft nodes before linearized reading' (duration: 1.129227649s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.014104Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:28.87821Z","time spent":"1.135876566s","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":28,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"info","ts":"2026-05-27T05:58:30.322093Z","caller":"traceutil/trace.go:171","msg":"trace[2035019066] transaction","detail":"{read_only:false; response_revision:12; number_of_response:1; }","duration":"306.92636ms","start":"2026-05-27T05:58:30.015143Z","end":"2026-05-27T05:58:30.322069Z","steps":["trace[2035019066] 'process raft request' (duration: 301.264475ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.322267Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015133Z","time spent":"307.029793ms","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.328652Z","caller":"traceutil/trace.go:171","msg":"trace[105545138] transaction","detail":"{read_only:false; response_revision:16; number_of_response:1; }","duration":"312.748111ms","start":"2026-05-27T05:58:30.015894Z","end":"2026-05-27T05:58:30.328642Z","steps":["trace[105545138] 'process raft request' (duration: 312.578015ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.328688Z","caller":"traceutil/trace.go:171","msg":"trace[1722420337] transaction","detail":"{read_only:false; response_revision:14; number_of_response:1; }","duration":"313.019049ms","start":"2026-05-27T05:58:30.015644Z","end":"2026-05-27T05:58:30.328663Z","steps":["trace[1722420337] 'process raft request' (duration: 312.766291ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.328719Z","caller":"traceutil/trace.go:171","msg":"trace[1639100723] transaction","detail":"{read_only:false; response_revision:18; number_of_response:1; }","duration":"312.758731ms","start":"2026-05-27T05:58:30.015941Z","end":"2026-05-27T05:58:30.3287Z","steps":["trace[1639100723] 'process raft request' (duration: 312.622197ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.32874Z","caller":"traceutil/trace.go:171","msg":"trace[118027683] linearizableReadLoop","detail":"{readStateIndex:17; appliedIndex:14; }","duration":"312.952937ms","start":"2026-05-27T05:58:30.015772Z","end":"2026-05-27T05:58:30.328725Z","steps":["trace[118027683] 'read index received' (duration: 300.676786ms)","trace[118027683] 'applied index is now lower than readState.Index' (duration: 12.275231ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:30.328765Z","caller":"traceutil/trace.go:171","msg":"trace[223590315] transaction","detail":"{read_only:false; response_revision:15; number_of_response:1; }","duration":"312.910516ms","start":"2026-05-27T05:58:30.015846Z","end":"2026-05-27T05:58:30.328756Z","steps":["trace[223590315] 'process raft request' (duration: 312.595146ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.328804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015838Z","time spent":"312.951667ms","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.328801Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015637Z","time spent":"313.115352ms","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":338,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.328735Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.01589Z","time spent":"312.796583ms","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":923,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.328847Z","caller":"traceutil/trace.go:171","msg":"trace[2038455199] transaction","detail":"{read_only:false; number_of_response:0; response_revision:18; }","duration":"311.672227ms","start":"2026-05-27T05:58:30.017159Z","end":"2026-05-27T05:58:30.328832Z","steps":["trace[2038455199] 'process raft request' (duration: 311.42713ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.328921Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.01715Z","time spent":"311.742319ms","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":28,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:30.328936Z","caller":"traceutil/trace.go:171","msg":"trace[874457946] transaction","detail":"{read_only:false; response_revision:17; number_of_response:1; }","duration":"312.986658ms","start":"2026-05-27T05:58:30.015938Z","end":"2026-05-27T05:58:30.328924Z","steps":["trace[874457946] 'process raft request' (duration: 312.584556ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.328813Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015917Z","time spent":"312.847714ms","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":965,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.328979Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"313.250787ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3490"} {"level":"warn","ts":"2026-05-27T05:58:30.328993Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015932Z","time spent":"313.030029ms","remote":"127.0.0.1:52768","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.329046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"313.332239ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/csr-wk7bm\" ","response":"range_response_count:1 size:861"} {"level":"info","ts":"2026-05-27T05:58:30.329056Z","caller":"traceutil/trace.go:171","msg":"trace[2081848646] transaction","detail":"{read_only:false; response_revision:19; number_of_response:1; }","duration":"311.749749ms","start":"2026-05-27T05:58:30.017295Z","end":"2026-05-27T05:58:30.329045Z","steps":["trace[2081848646] 'process raft request' (duration: 311.313326ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.328837Z","caller":"traceutil/trace.go:171","msg":"trace[777946469] transaction","detail":"{read_only:false; response_revision:20; number_of_response:1; }","duration":"309.109127ms","start":"2026-05-27T05:58:30.019715Z","end":"2026-05-27T05:58:30.328824Z","steps":["trace[777946469] 'process raft request' (duration: 308.964303ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.329087Z","caller":"traceutil/trace.go:171","msg":"trace[924353934] range","detail":"{range_begin:/registry/certificatesigningrequests/csr-wk7bm; range_end:; response_count:1; response_revision:20; }","duration":"313.407281ms","start":"2026-05-27T05:58:30.015671Z","end":"2026-05-27T05:58:30.329078Z","steps":["trace[924353934] 'agreement among raft nodes before linearized reading' (duration: 313.353069ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.329112Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.017276Z","time spent":"311.808871ms","remote":"127.0.0.1:52586","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":429,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.329155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015662Z","time spent":"313.454093ms","remote":"127.0.0.1:52500","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":885,"request content":"key:\"/registry/certificatesigningrequests/csr-wk7bm\" "} {"level":"warn","ts":"2026-05-27T05:58:30.328933Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"313.153104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:aggregate-to-edit\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.329007Z","caller":"traceutil/trace.go:171","msg":"trace[1028569665] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:20; }","duration":"313.283358ms","start":"2026-05-27T05:58:30.015714Z","end":"2026-05-27T05:58:30.328998Z","steps":["trace[1028569665] 'agreement among raft nodes before linearized reading' (duration: 313.240456ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:30.329197Z","caller":"traceutil/trace.go:171","msg":"trace[727140105] range","detail":"{range_begin:/registry/clusterroles/system:aggregate-to-edit; range_end:; response_count:0; response_revision:20; }","duration":"313.430282ms","start":"2026-05-27T05:58:30.015756Z","end":"2026-05-27T05:58:30.329186Z","steps":["trace[727140105] 'agreement among raft nodes before linearized reading' (duration: 313.099192ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.329156Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.019704Z","time spent":"309.393116ms","remote":"127.0.0.1:52406","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3478,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:58:30.329213Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015708Z","time spent":"313.490254ms","remote":"127.0.0.1:52406","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":3514,"request content":"key:\"/registry/minions/instance\" "} {"level":"warn","ts":"2026-05-27T05:58:30.329227Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015754Z","time spent":"313.465683ms","remote":"127.0.0.1:52572","response type":"/etcdserverpb.KV/Range","request count":0,"request size":49,"response count":0,"response size":28,"request content":"key:\"/registry/clusterroles/system:aggregate-to-edit\" "} {"level":"info","ts":"2026-05-27T05:58:30.328557Z","caller":"traceutil/trace.go:171","msg":"trace[458702651] transaction","detail":"{read_only:false; response_revision:13; number_of_response:1; }","duration":"312.917866ms","start":"2026-05-27T05:58:30.015615Z","end":"2026-05-27T05:58:30.328532Z","steps":["trace[458702651] 'process raft request' (duration: 312.70166ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.329357Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:30.015605Z","time spent":"313.717031ms","remote":"127.0.0.1:52694","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":704,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:30.329906Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.763299ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-node-lease\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.329961Z","caller":"traceutil/trace.go:171","msg":"trace[716297740] range","detail":"{range_begin:/registry/namespaces/kube-node-lease; range_end:; response_count:0; response_revision:21; }","duration":"263.843602ms","start":"2026-05-27T05:58:30.066106Z","end":"2026-05-27T05:58:30.329949Z","steps":["trace[716297740] 'agreement among raft nodes before linearized reading' (duration: 263.722148ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.330144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.828467ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:350"} {"level":"info","ts":"2026-05-27T05:58:30.330179Z","caller":"traceutil/trace.go:171","msg":"trace[88331224] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:21; }","duration":"176.899979ms","start":"2026-05-27T05:58:30.15327Z","end":"2026-05-27T05:58:30.33017Z","steps":["trace[88331224] 'agreement among raft nodes before linearized reading' (duration: 176.832097ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.330255Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.398001ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:350"} {"level":"info","ts":"2026-05-27T05:58:30.330288Z","caller":"traceutil/trace.go:171","msg":"trace[1516127389] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:21; }","duration":"257.450502ms","start":"2026-05-27T05:58:30.07283Z","end":"2026-05-27T05:58:30.33028Z","steps":["trace[1516127389] 'agreement among raft nodes before linearized reading' (duration: 257.38428ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:30.330463Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.093476ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-27T05:58:30.330791Z","caller":"traceutil/trace.go:171","msg":"trace[830360405] range","detail":"{range_begin:/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te; range_end:; response_count:0; response_revision:21; }","duration":"113.679844ms","start":"2026-05-27T05:58:30.216986Z","end":"2026-05-27T05:58:30.330666Z","steps":["trace[830360405] 'agreement among raft nodes before linearized reading' (duration: 113.047904ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.14711Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.498934ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:58:33.147347Z","caller":"traceutil/trace.go:171","msg":"trace[87379999] linearizableReadLoop","detail":"{readStateIndex:281; appliedIndex:278; }","duration":"144.75276ms","start":"2026-05-27T05:58:33.002578Z","end":"2026-05-27T05:58:33.147331Z","steps":["trace[87379999] 'read index received' (duration: 27.589625ms)","trace[87379999] 'applied index is now lower than readState.Index' (duration: 117.162185ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:33.147411Z","caller":"traceutil/trace.go:171","msg":"trace[29828990] transaction","detail":"{read_only:false; response_revision:275; number_of_response:1; }","duration":"165.023175ms","start":"2026-05-27T05:58:32.98238Z","end":"2026-05-27T05:58:33.147403Z","steps":["trace[29828990] 'process raft request' (duration: 164.906851ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.147461Z","caller":"traceutil/trace.go:171","msg":"trace[765084269] transaction","detail":"{read_only:false; response_revision:273; number_of_response:1; }","duration":"168.10797ms","start":"2026-05-27T05:58:32.979326Z","end":"2026-05-27T05:58:33.147433Z","steps":["trace[765084269] 'process raft request' (duration: 50.923405ms)","trace[765084269] 'compare' (duration: 116.314388ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:33.147462Z","caller":"traceutil/trace.go:171","msg":"trace[1166154099] transaction","detail":"{read_only:false; response_revision:274; number_of_response:1; }","duration":"166.641885ms","start":"2026-05-27T05:58:32.980791Z","end":"2026-05-27T05:58:33.147432Z","steps":["trace[1166154099] 'process raft request' (duration: 166.423008ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.147553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.948975ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/generic-garbage-collector\" ","response":"range_response_count:1 size:216"} {"level":"info","ts":"2026-05-27T05:58:33.14764Z","caller":"traceutil/trace.go:171","msg":"trace[240882960] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/generic-garbage-collector; range_end:; response_count:1; response_revision:275; }","duration":"145.061919ms","start":"2026-05-27T05:58:33.00255Z","end":"2026-05-27T05:58:33.147612Z","steps":["trace[240882960] 'agreement among raft nodes before linearized reading' (duration: 144.883244ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.402708Z","caller":"traceutil/trace.go:171","msg":"trace[1311429832] transaction","detail":"{read_only:false; response_revision:281; number_of_response:1; }","duration":"251.617147ms","start":"2026-05-27T05:58:33.151066Z","end":"2026-05-27T05:58:33.402683Z","steps":["trace[1311429832] 'process raft request' (duration: 251.579086ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.402803Z","caller":"traceutil/trace.go:171","msg":"trace[808850132] transaction","detail":"{read_only:false; response_revision:278; number_of_response:1; }","duration":"309.118352ms","start":"2026-05-27T05:58:33.093644Z","end":"2026-05-27T05:58:33.402763Z","steps":["trace[808850132] 'process raft request' (duration: 308.913446ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.402927Z","caller":"traceutil/trace.go:171","msg":"trace[1048943348] transaction","detail":"{read_only:false; response_revision:279; number_of_response:1; }","duration":"308.782332ms","start":"2026-05-27T05:58:33.094134Z","end":"2026-05-27T05:58:33.402916Z","steps":["trace[1048943348] 'process raft request' (duration: 308.449451ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.402939Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.093637Z","time spent":"309.238987ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5877,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:33.403002Z","caller":"traceutil/trace.go:171","msg":"trace[1198221063] linearizableReadLoop","detail":"{readStateIndex:287; appliedIndex:282; }","duration":"255.608011ms","start":"2026-05-27T05:58:33.147374Z","end":"2026-05-27T05:58:33.402982Z","steps":["trace[1198221063] 'read index received' (duration: 1.036252ms)","trace[1198221063] 'applied index is now lower than readState.Index' (duration: 254.570439ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:33.403042Z","caller":"traceutil/trace.go:171","msg":"trace[1418071498] transaction","detail":"{read_only:false; response_revision:276; number_of_response:1; }","duration":"310.720611ms","start":"2026-05-27T05:58:33.092292Z","end":"2026-05-27T05:58:33.403013Z","steps":["trace[1418071498] 'process raft request' (duration: 310.162613ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.403053Z","caller":"traceutil/trace.go:171","msg":"trace[2019758856] transaction","detail":"{read_only:false; number_of_response:0; response_revision:275; }","duration":"311.100823ms","start":"2026-05-27T05:58:33.091933Z","end":"2026-05-27T05:58:33.403034Z","steps":["trace[2019758856] 'process raft request' (duration: 213.654514ms)","trace[2019758856] 'compare' (duration: 96.812809ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:58:33.40312Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"319.868063ms","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-27T05:58:33.403148Z","caller":"traceutil/trace.go:171","msg":"trace[649124074] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:0; response_revision:281; }","duration":"319.932745ms","start":"2026-05-27T05:58:33.083207Z","end":"2026-05-27T05:58:33.40314Z","steps":["trace[649124074] 'agreement among raft nodes before linearized reading' (duration: 319.872243ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.403142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.09191Z","time spent":"311.198327ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":29,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:33.403157Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.092261Z","time spent":"310.845785ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3959,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:58:33.403118Z","caller":"traceutil/trace.go:171","msg":"trace[1170981453] transaction","detail":"{read_only:false; response_revision:280; number_of_response:1; }","duration":"254.464496ms","start":"2026-05-27T05:58:33.148643Z","end":"2026-05-27T05:58:33.403108Z","steps":["trace[1170981453] 'process raft request' (duration: 253.97194ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.403173Z","caller":"traceutil/trace.go:171","msg":"trace[1685546242] transaction","detail":"{read_only:false; response_revision:277; number_of_response:1; }","duration":"310.389922ms","start":"2026-05-27T05:58:33.092771Z","end":"2026-05-27T05:58:33.403161Z","steps":["trace[1685546242] 'process raft request' (duration: 309.752341ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.403224Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.092686Z","time spent":"310.514575ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2905,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:33.403005Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.094125Z","time spent":"308.829335ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5498,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:58:33.403171Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:58:33.08319Z","time spent":"319.975406ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":29,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-27T05:58:33.404279Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.878557ms","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-27T05:58:33.404578Z","caller":"traceutil/trace.go:171","msg":"trace[1381999748] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:281; }","duration":"253.185827ms","start":"2026-05-27T05:58:33.151353Z","end":"2026-05-27T05:58:33.404539Z","steps":["trace[1381999748] 'agreement among raft nodes before linearized reading' (duration: 251.955639ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.404293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.107135ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:4016"} {"level":"warn","ts":"2026-05-27T05:58:33.40563Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.32701ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/generic-garbage-collector\" ","response":"range_response_count:1 size:216"} {"level":"info","ts":"2026-05-27T05:58:33.40567Z","caller":"traceutil/trace.go:171","msg":"trace[685358910] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/generic-garbage-collector; range_end:; response_count:1; response_revision:281; }","duration":"254.688341ms","start":"2026-05-27T05:58:33.150961Z","end":"2026-05-27T05:58:33.405649Z","steps":["trace[685358910] 'agreement among raft nodes before linearized reading' (duration: 252.314539ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.405667Z","caller":"traceutil/trace.go:171","msg":"trace[661781830] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:281; }","duration":"256.426186ms","start":"2026-05-27T05:58:33.149203Z","end":"2026-05-27T05:58:33.405629Z","steps":["trace[661781830] 'agreement among raft nodes before linearized reading' (duration: 254.036573ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.405576Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.598789ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:58:33.405987Z","caller":"traceutil/trace.go:171","msg":"trace[1518249873] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/deployment-controller; range_end:; response_count:0; response_revision:281; }","duration":"254.997002ms","start":"2026-05-27T05:58:33.150967Z","end":"2026-05-27T05:58:33.405964Z","steps":["trace[1518249873] 'agreement among raft nodes before linearized reading' (duration: 254.575098ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.585718Z","caller":"traceutil/trace.go:171","msg":"trace[210162866] transaction","detail":"{read_only:false; response_revision:286; number_of_response:1; }","duration":"159.022608ms","start":"2026-05-27T05:58:33.42668Z","end":"2026-05-27T05:58:33.585702Z","steps":["trace[210162866] 'process raft request' (duration: 158.988017ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.585755Z","caller":"traceutil/trace.go:171","msg":"trace[189207254] transaction","detail":"{read_only:false; response_revision:284; number_of_response:1; }","duration":"174.278586ms","start":"2026-05-27T05:58:33.411455Z","end":"2026-05-27T05:58:33.585733Z","steps":["trace[189207254] 'process raft request' (duration: 174.133361ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.585784Z","caller":"traceutil/trace.go:171","msg":"trace[2138389069] transaction","detail":"{read_only:false; response_revision:285; number_of_response:1; }","duration":"173.76623ms","start":"2026-05-27T05:58:33.412009Z","end":"2026-05-27T05:58:33.585775Z","steps":["trace[2138389069] 'process raft request' (duration: 173.623346ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:33.585708Z","caller":"traceutil/trace.go:171","msg":"trace[1538971259] transaction","detail":"{read_only:false; response_revision:283; number_of_response:1; }","duration":"176.04069ms","start":"2026-05-27T05:58:33.409635Z","end":"2026-05-27T05:58:33.585676Z","steps":["trace[1538971259] 'process raft request' (duration: 126.780739ms)","trace[1538971259] 'compare' (duration: 49.079436ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:33.585903Z","caller":"traceutil/trace.go:171","msg":"trace[1702848032] linearizableReadLoop","detail":"{readStateIndex:291; appliedIndex:289; }","duration":"174.650528ms","start":"2026-05-27T05:58:33.411242Z","end":"2026-05-27T05:58:33.585893Z","steps":["trace[1702848032] 'read index received' (duration: 11.556655ms)","trace[1702848032] 'applied index is now lower than readState.Index' (duration: 163.092963ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:58:33.586077Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.795692ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:4016"} {"level":"info","ts":"2026-05-27T05:58:33.586123Z","caller":"traceutil/trace.go:171","msg":"trace[1462998612] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:286; }","duration":"174.888625ms","start":"2026-05-27T05:58:33.411221Z","end":"2026-05-27T05:58:33.58611Z","steps":["trace[1462998612] 'agreement among raft nodes before linearized reading' (duration: 174.73131ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.586153Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.793612ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-05-27T05:58:33.58619Z","caller":"traceutil/trace.go:171","msg":"trace[1237851712] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:286; }","duration":"174.849273ms","start":"2026-05-27T05:58:33.411327Z","end":"2026-05-27T05:58:33.586177Z","steps":["trace[1237851712] 'agreement among raft nodes before linearized reading' (duration: 174.770901ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:33.586214Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.782641ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/generic-garbage-collector\" ","response":"range_response_count:1 size:216"} {"level":"info","ts":"2026-05-27T05:58:33.586282Z","caller":"traceutil/trace.go:171","msg":"trace[1969082964] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/generic-garbage-collector; range_end:; response_count:1; response_revision:286; }","duration":"174.869984ms","start":"2026-05-27T05:58:33.411393Z","end":"2026-05-27T05:58:33.586263Z","steps":["trace[1969082964] 'agreement among raft nodes before linearized reading' (duration: 174.73608ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:34.218024Z","caller":"traceutil/trace.go:171","msg":"trace[1482243482] transaction","detail":"{read_only:false; response_revision:302; number_of_response:1; }","duration":"212.732997ms","start":"2026-05-27T05:58:34.005258Z","end":"2026-05-27T05:58:34.217991Z","steps":["trace[1482243482] 'process raft request' (duration: 212.458308ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:34.21807Z","caller":"traceutil/trace.go:171","msg":"trace[439111677] transaction","detail":"{read_only:false; number_of_response:0; response_revision:302; }","duration":"212.231141ms","start":"2026-05-27T05:58:34.005819Z","end":"2026-05-27T05:58:34.21805Z","steps":["trace[439111677] 'process raft request' (duration: 212.070507ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:34.218123Z","caller":"traceutil/trace.go:171","msg":"trace[1119185665] linearizableReadLoop","detail":"{readStateIndex:315; appliedIndex:310; }","duration":"173.703345ms","start":"2026-05-27T05:58:34.044397Z","end":"2026-05-27T05:58:34.2181Z","steps":["trace[1119185665] 'read index received' (duration: 173.202879ms)","trace[1119185665] 'applied index is now lower than readState.Index' (duration: 499.436µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:34.218185Z","caller":"traceutil/trace.go:171","msg":"trace[1435663513] transaction","detail":"{read_only:false; response_revision:303; number_of_response:1; }","duration":"195.896373ms","start":"2026-05-27T05:58:34.022267Z","end":"2026-05-27T05:58:34.218163Z","steps":["trace[1435663513] 'process raft request' (duration: 195.780588ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:34.218349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.902292ms","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-27T05:58:34.218415Z","caller":"traceutil/trace.go:171","msg":"trace[64561539] range","detail":"{range_begin:/registry/pods/kube-system/kube-scheduler-instance; range_end:; response_count:1; response_revision:303; }","duration":"174.048446ms","start":"2026-05-27T05:58:34.044353Z","end":"2026-05-27T05:58:34.218401Z","steps":["trace[64561539] 'agreement among raft nodes before linearized reading' (duration: 173.826529ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:34.218357Z","caller":"traceutil/trace.go:171","msg":"trace[383527077] transaction","detail":"{read_only:false; number_of_response:0; response_revision:302; }","duration":"211.942404ms","start":"2026-05-27T05:58:34.006181Z","end":"2026-05-27T05:58:34.218124Z","steps":["trace[383527077] 'process raft request' (duration: 211.83855ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:34.21815Z","caller":"traceutil/trace.go:171","msg":"trace[427346464] transaction","detail":"{read_only:false; number_of_response:0; response_revision:302; }","duration":"211.953944ms","start":"2026-05-27T05:58:34.006178Z","end":"2026-05-27T05:58:34.218132Z","steps":["trace[427346464] 'process raft request' (duration: 211.746827ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:35.180118Z","caller":"traceutil/trace.go:171","msg":"trace[1485061382] transaction","detail":"{read_only:false; response_revision:316; number_of_response:1; }","duration":"176.979871ms","start":"2026-05-27T05:58:35.00311Z","end":"2026-05-27T05:58:35.18009Z","steps":["trace[1485061382] 'process raft request' (duration: 176.806006ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:35.9026Z","caller":"traceutil/trace.go:171","msg":"trace[2101062498] transaction","detail":"{read_only:false; response_revision:323; number_of_response:1; }","duration":"112.044527ms","start":"2026-05-27T05:58:35.790512Z","end":"2026-05-27T05:58:35.902556Z","steps":["trace[2101062498] 'process raft request' (duration: 34.053675ms)","trace[2101062498] 'compare' (duration: 77.750325ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:58:36.124662Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.047335ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" ","response":"range_response_count:1 size:203"} {"level":"info","ts":"2026-05-27T05:58:36.124752Z","caller":"traceutil/trace.go:171","msg":"trace[1757541045] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpoint-controller; range_end:; response_count:1; response_revision:324; }","duration":"122.202221ms","start":"2026-05-27T05:58:36.00253Z","end":"2026-05-27T05:58:36.124732Z","steps":["trace[1757541045] 'range keys from in-memory index tree' (duration: 121.895031ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:36.320386Z","caller":"traceutil/trace.go:171","msg":"trace[1383877147] linearizableReadLoop","detail":"{readStateIndex:337; appliedIndex:336; }","duration":"168.316356ms","start":"2026-05-27T05:58:36.152044Z","end":"2026-05-27T05:58:36.32036Z","steps":["trace[1383877147] 'read index received' (duration: 168.152202ms)","trace[1383877147] 'applied index is now lower than readState.Index' (duration: 163.064µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:36.320439Z","caller":"traceutil/trace.go:171","msg":"trace[1003294234] transaction","detail":"{read_only:false; response_revision:325; number_of_response:1; }","duration":"188.055534ms","start":"2026-05-27T05:58:36.13235Z","end":"2026-05-27T05:58:36.320405Z","steps":["trace[1003294234] 'process raft request' (duration: 187.845568ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.320658Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.596235ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-27T05:58:36.320722Z","caller":"traceutil/trace.go:171","msg":"trace[1733306398] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/certificate-controller; range_end:; response_count:1; response_revision:325; }","duration":"168.696988ms","start":"2026-05-27T05:58:36.152008Z","end":"2026-05-27T05:58:36.320704Z","steps":["trace[1733306398] 'agreement among raft nodes before linearized reading' (duration: 168.505882ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.320695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.342853ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/bootstrap-signer\" ","response":"range_response_count:1 size:197"} {"level":"info","ts":"2026-05-27T05:58:36.32078Z","caller":"traceutil/trace.go:171","msg":"trace[910561426] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/bootstrap-signer; range_end:; response_count:1; response_revision:325; }","duration":"117.457907ms","start":"2026-05-27T05:58:36.203309Z","end":"2026-05-27T05:58:36.320767Z","steps":["trace[910561426] 'agreement among raft nodes before linearized reading' (duration: 117.210759ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.992635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.269215ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:58:36.99277Z","caller":"traceutil/trace.go:171","msg":"trace[662525911] transaction","detail":"{read_only:false; response_revision:332; number_of_response:1; }","duration":"284.022499ms","start":"2026-05-27T05:58:36.708723Z","end":"2026-05-27T05:58:36.992746Z","steps":["trace[662525911] 'process raft request' (duration: 113.539777ms)","trace[662525911] 'compare' (duration: 170.071079ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:36.993122Z","caller":"traceutil/trace.go:171","msg":"trace[1823864655] linearizableReadLoop","detail":"{readStateIndex:346; appliedIndex:343; }","duration":"239.719447ms","start":"2026-05-27T05:58:36.753384Z","end":"2026-05-27T05:58:36.993104Z","steps":["trace[1823864655] 'read index received' (duration: 68.887105ms)","trace[1823864655] 'applied index is now lower than readState.Index' (duration: 170.831352ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:36.993229Z","caller":"traceutil/trace.go:171","msg":"trace[1818820292] transaction","detail":"{read_only:false; response_revision:334; number_of_response:1; }","duration":"281.826293ms","start":"2026-05-27T05:58:36.711386Z","end":"2026-05-27T05:58:36.993212Z","steps":["trace[1818820292] 'process raft request' (duration: 281.678338ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.993288Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"239.897443ms","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-27T05:58:36.993329Z","caller":"traceutil/trace.go:171","msg":"trace[1019551188] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:1; response_revision:334; }","duration":"239.978367ms","start":"2026-05-27T05:58:36.753338Z","end":"2026-05-27T05:58:36.993316Z","steps":["trace[1019551188] 'agreement among raft nodes before linearized reading' (duration: 239.867743ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.993545Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.615881ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-27T05:58:36.993591Z","caller":"traceutil/trace.go:171","msg":"trace[1174036993] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/certificate-controller; range_end:; response_count:1; response_revision:334; }","duration":"190.702204ms","start":"2026-05-27T05:58:36.802876Z","end":"2026-05-27T05:58:36.993578Z","steps":["trace[1174036993] 'agreement among raft nodes before linearized reading' (duration: 190.630291ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:36.993794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.39748ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-05-27T05:58:36.993861Z","caller":"traceutil/trace.go:171","msg":"trace[981534960] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ttl-controller; range_end:; response_count:1; response_revision:334; }","duration":"139.542675ms","start":"2026-05-27T05:58:36.854301Z","end":"2026-05-27T05:58:36.993843Z","steps":["trace[981534960] 'agreement among raft nodes before linearized reading' (duration: 139.425941ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:36.994482Z","caller":"traceutil/trace.go:171","msg":"trace[2117766762] transaction","detail":"{read_only:false; response_revision:333; number_of_response:1; }","duration":"283.986189ms","start":"2026-05-27T05:58:36.710452Z","end":"2026-05-27T05:58:36.994438Z","steps":["trace[2117766762] 'process raft request' (duration: 282.493934ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.236087Z","caller":"traceutil/trace.go:171","msg":"trace[1363372871] transaction","detail":"{read_only:false; response_revision:338; number_of_response:1; }","duration":"232.569681ms","start":"2026-05-27T05:58:37.003492Z","end":"2026-05-27T05:58:37.236062Z","steps":["trace[1363372871] 'process raft request' (duration: 232.411866ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.236111Z","caller":"traceutil/trace.go:171","msg":"trace[420619369] transaction","detail":"{read_only:false; response_revision:336; number_of_response:1; }","duration":"234.383346ms","start":"2026-05-27T05:58:37.001676Z","end":"2026-05-27T05:58:37.236059Z","steps":["trace[420619369] 'process raft request' (duration: 186.935225ms)","trace[420619369] 'compare' (duration: 47.0733ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:37.236198Z","caller":"traceutil/trace.go:171","msg":"trace[504965333] linearizableReadLoop","detail":"{readStateIndex:351; appliedIndex:347; }","duration":"232.222061ms","start":"2026-05-27T05:58:37.003955Z","end":"2026-05-27T05:58:37.236177Z","steps":["trace[504965333] 'read index received' (duration: 41.79686ms)","trace[504965333] 'applied index is now lower than readState.Index' (duration: 190.4225ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:37.236109Z","caller":"traceutil/trace.go:171","msg":"trace[1807370740] transaction","detail":"{read_only:false; response_revision:340; number_of_response:1; }","duration":"186.151223ms","start":"2026-05-27T05:58:37.049938Z","end":"2026-05-27T05:58:37.23609Z","steps":["trace[1807370740] 'process raft request' (duration: 186.097281ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:37.236512Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.76478ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/replicaset-controller\" ","response":"range_response_count:1 size:207"} {"level":"warn","ts":"2026-05-27T05:58:37.236529Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.644554ms","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-27T05:58:37.236595Z","caller":"traceutil/trace.go:171","msg":"trace[324541932] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/replicaset-controller; range_end:; response_count:1; response_revision:340; }","duration":"183.938995ms","start":"2026-05-27T05:58:37.052638Z","end":"2026-05-27T05:58:37.236577Z","steps":["trace[324541932] 'agreement among raft nodes before linearized reading' (duration: 183.75889ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.236636Z","caller":"traceutil/trace.go:171","msg":"trace[369506816] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller; range_end:; response_count:1; response_revision:340; }","duration":"231.785627ms","start":"2026-05-27T05:58:37.004826Z","end":"2026-05-27T05:58:37.236611Z","steps":["trace[369506816] 'agreement among raft nodes before linearized reading' (duration: 231.563311ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.236656Z","caller":"traceutil/trace.go:171","msg":"trace[288710235] transaction","detail":"{read_only:false; response_revision:337; number_of_response:1; }","duration":"234.694645ms","start":"2026-05-27T05:58:37.00195Z","end":"2026-05-27T05:58:37.236644Z","steps":["trace[288710235] 'process raft request' (duration: 233.896052ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:58:37.236854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.819569ms","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-27T05:58:37.236967Z","caller":"traceutil/trace.go:171","msg":"trace[765798712] range","detail":"{range_begin:/registry/deployments/kube-system/coredns; range_end:; response_count:1; response_revision:340; }","duration":"233.030195ms","start":"2026-05-27T05:58:37.003919Z","end":"2026-05-27T05:58:37.236949Z","steps":["trace[765798712] 'agreement among raft nodes before linearized reading' (duration: 232.386815ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.237141Z","caller":"traceutil/trace.go:171","msg":"trace[1074892404] transaction","detail":"{read_only:false; response_revision:339; number_of_response:1; }","duration":"233.219341ms","start":"2026-05-27T05:58:37.003867Z","end":"2026-05-27T05:58:37.237086Z","steps":["trace[1074892404] 'process raft request' (duration: 232.097667ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.459978Z","caller":"traceutil/trace.go:171","msg":"trace[1981007586] transaction","detail":"{read_only:false; response_revision:351; number_of_response:1; }","duration":"151.361603ms","start":"2026-05-27T05:58:37.308593Z","end":"2026-05-27T05:58:37.459954Z","steps":["trace[1981007586] 'process raft request' (duration: 151.26587ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.460378Z","caller":"traceutil/trace.go:171","msg":"trace[951225765] transaction","detail":"{read_only:false; response_revision:350; number_of_response:1; }","duration":"152.001273ms","start":"2026-05-27T05:58:37.308351Z","end":"2026-05-27T05:58:37.460352Z","steps":["trace[951225765] 'process raft request' (duration: 98.402557ms)","trace[951225765] 'compare' (duration: 52.950437ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:37.46077Z","caller":"traceutil/trace.go:171","msg":"trace[180933492] transaction","detail":"{read_only:false; response_revision:356; number_of_response:1; }","duration":"147.666272ms","start":"2026-05-27T05:58:37.313089Z","end":"2026-05-27T05:58:37.460756Z","steps":["trace[180933492] 'process raft request' (duration: 147.5894ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.460844Z","caller":"traceutil/trace.go:171","msg":"trace[1361627139] transaction","detail":"{read_only:false; response_revision:354; number_of_response:1; }","duration":"150.120686ms","start":"2026-05-27T05:58:37.310705Z","end":"2026-05-27T05:58:37.460825Z","steps":["trace[1361627139] 'process raft request' (duration: 149.726374ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.460895Z","caller":"traceutil/trace.go:171","msg":"trace[1386514520] transaction","detail":"{read_only:false; response_revision:352; number_of_response:1; }","duration":"152.127356ms","start":"2026-05-27T05:58:37.308741Z","end":"2026-05-27T05:58:37.460869Z","steps":["trace[1386514520] 'process raft request' (duration: 151.174778ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.461427Z","caller":"traceutil/trace.go:171","msg":"trace[430517536] transaction","detail":"{read_only:false; response_revision:355; number_of_response:1; }","duration":"148.59725ms","start":"2026-05-27T05:58:37.312812Z","end":"2026-05-27T05:58:37.461409Z","steps":["trace[430517536] 'process raft request' (duration: 147.836748ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.460794Z","caller":"traceutil/trace.go:171","msg":"trace[1401507626] transaction","detail":"{read_only:false; response_revision:353; number_of_response:1; }","duration":"150.567399ms","start":"2026-05-27T05:58:37.310208Z","end":"2026-05-27T05:58:37.460776Z","steps":["trace[1401507626] 'process raft request' (duration: 150.167658ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.590662Z","caller":"traceutil/trace.go:171","msg":"trace[1400407950] transaction","detail":"{read_only:false; response_revision:358; number_of_response:1; }","duration":"122.41008ms","start":"2026-05-27T05:58:37.46821Z","end":"2026-05-27T05:58:37.59062Z","steps":["trace[1400407950] 'process raft request' (duration: 110.777339ms)","trace[1400407950] 'compare' (duration: 11.306201ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:58:37.591018Z","caller":"traceutil/trace.go:171","msg":"trace[1371283329] transaction","detail":"{read_only:false; response_revision:359; number_of_response:1; }","duration":"122.599046ms","start":"2026-05-27T05:58:37.468405Z","end":"2026-05-27T05:58:37.591004Z","steps":["trace[1371283329] 'process raft request' (duration: 122.032398ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.591128Z","caller":"traceutil/trace.go:171","msg":"trace[1151603887] transaction","detail":"{read_only:false; response_revision:360; number_of_response:1; }","duration":"122.488373ms","start":"2026-05-27T05:58:37.468615Z","end":"2026-05-27T05:58:37.591104Z","steps":["trace[1151603887] 'process raft request' (duration: 121.951466ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.591504Z","caller":"traceutil/trace.go:171","msg":"trace[160103826] transaction","detail":"{read_only:false; response_revision:361; number_of_response:1; }","duration":"119.42515ms","start":"2026-05-27T05:58:37.472057Z","end":"2026-05-27T05:58:37.591482Z","steps":["trace[160103826] 'process raft request' (duration: 118.570234ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:37.591555Z","caller":"traceutil/trace.go:171","msg":"trace[1288526074] transaction","detail":"{read_only:false; response_revision:362; number_of_response:1; }","duration":"105.12466ms","start":"2026-05-27T05:58:37.486417Z","end":"2026-05-27T05:58:37.591542Z","steps":["trace[1288526074] 'process raft request' (duration: 104.281664ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:58:49.80862Z","caller":"traceutil/trace.go:171","msg":"trace[171925129] transaction","detail":"{read_only:false; response_revision:415; number_of_response:1; }","duration":"132.90837ms","start":"2026-05-27T05:58:49.675689Z","end":"2026-05-27T05:58:49.808597Z","steps":["trace[171925129] 'process raft request' (duration: 106.158633ms)","trace[171925129] 'compare' (duration: 26.668655ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:05.153172Z","caller":"traceutil/trace.go:171","msg":"trace[1644377818] transaction","detail":"{read_only:false; response_revision:517; number_of_response:1; }","duration":"446.358533ms","start":"2026-05-27T05:59:04.706783Z","end":"2026-05-27T05:59:05.153141Z","steps":["trace[1644377818] 'process raft request' (duration: 446.200538ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.153307Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.706764Z","time spent":"446.484766ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.262287Z","caller":"traceutil/trace.go:171","msg":"trace[588356628] transaction","detail":"{read_only:false; response_revision:519; number_of_response:1; }","duration":"555.276311ms","start":"2026-05-27T05:59:04.706969Z","end":"2026-05-27T05:59:05.262245Z","steps":["trace[588356628] 'process raft request' (duration: 555.111197ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:05.262462Z","caller":"traceutil/trace.go:171","msg":"trace[2021466628] transaction","detail":"{read_only:false; response_revision:521; number_of_response:1; }","duration":"527.280115ms","start":"2026-05-27T05:59:04.735121Z","end":"2026-05-27T05:59:05.262401Z","steps":["trace[2021466628] 'process raft request' (duration: 527.07344ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:05.262541Z","caller":"traceutil/trace.go:171","msg":"trace[1307501848] transaction","detail":"{read_only:false; response_revision:522; number_of_response:1; }","duration":"527.315706ms","start":"2026-05-27T05:59:04.735154Z","end":"2026-05-27T05:59:05.26247Z","steps":["trace[1307501848] 'process raft request' (duration: 527.0985ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.262651Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.735118Z","time spent":"527.44521ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.26257Z","caller":"traceutil/trace.go:171","msg":"trace[1363311284] transaction","detail":"{read_only:false; response_revision:523; number_of_response:1; }","duration":"527.275015ms","start":"2026-05-27T05:59:04.735211Z","end":"2026-05-27T05:59:05.262486Z","steps":["trace[1363311284] 'process raft request' (duration: 527.08353ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.262722Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.73515Z","time spent":"527.496101ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28462,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:59:05.262684Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.706929Z","time spent":"555.571499ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.262828Z","caller":"traceutil/trace.go:171","msg":"trace[547861180] transaction","detail":"{read_only:false; response_revision:518; number_of_response:1; }","duration":"555.869046ms","start":"2026-05-27T05:59:04.706906Z","end":"2026-05-27T05:59:05.262775Z","steps":["trace[547861180] 'process raft request' (duration: 555.009663ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.262878Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.735207Z","time spent":"527.525772ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.263011Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.706858Z","time spent":"556.079273ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.263027Z","caller":"traceutil/trace.go:171","msg":"trace[627920806] transaction","detail":"{read_only:false; response_revision:524; number_of_response:1; }","duration":"520.434519ms","start":"2026-05-27T05:59:04.742568Z","end":"2026-05-27T05:59:05.263003Z","steps":["trace[627920806] 'process raft request' (duration: 519.801733ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:05.262405Z","caller":"traceutil/trace.go:171","msg":"trace[727874188] transaction","detail":"{read_only:false; response_revision:520; number_of_response:1; }","duration":"527.233784ms","start":"2026-05-27T05:59:04.735063Z","end":"2026-05-27T05:59:05.262297Z","steps":["trace[727874188] 'process raft request' (duration: 527.071229ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.263201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.735044Z","time spent":"528.112038ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29801,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:59:05.263105Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.742559Z","time spent":"520.513872ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.263339Z","caller":"traceutil/trace.go:171","msg":"trace[31786451] transaction","detail":"{read_only:false; response_revision:525; number_of_response:1; }","duration":"506.67627ms","start":"2026-05-27T05:59:04.756644Z","end":"2026-05-27T05:59:05.26332Z","steps":["trace[31786451] 'process raft request' (duration: 505.96896ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:05.263418Z","caller":"traceutil/trace.go:171","msg":"trace[677526644] transaction","detail":"{read_only:false; response_revision:526; number_of_response:1; }","duration":"498.812357ms","start":"2026-05-27T05:59:04.764587Z","end":"2026-05-27T05:59:05.2634Z","steps":["trace[677526644] 'process raft request' (duration: 498.605941ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.263567Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.764579Z","time spent":"498.9258ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.26343Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.756625Z","time spent":"506.772122ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:59:05.263771Z","caller":"traceutil/trace.go:171","msg":"trace[477843457] transaction","detail":"{read_only:false; response_revision:527; number_of_response:1; }","duration":"483.104043ms","start":"2026-05-27T05:59:04.780651Z","end":"2026-05-27T05:59:05.263755Z","steps":["trace[477843457] 'process raft request' (duration: 482.756034ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.263856Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.780619Z","time spent":"483.180995ms","remote":"127.0.0.1:52304","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-05-27T05:59:05.264131Z","caller":"traceutil/trace.go:171","msg":"trace[968013145] transaction","detail":"{read_only:false; response_revision:528; number_of_response:1; }","duration":"383.195536ms","start":"2026-05-27T05:59:04.880902Z","end":"2026-05-27T05:59:05.264098Z","steps":["trace[968013145] 'process raft request' (duration: 382.917229ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:05.264356Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:04.880872Z","time spent":"383.33691ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":149907,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:59:05.363015Z","caller":"traceutil/trace.go:171","msg":"trace[357055987] transaction","detail":"{read_only:false; response_revision:530; number_of_response:1; }","duration":"198.523118ms","start":"2026-05-27T05:59:05.164345Z","end":"2026-05-27T05:59:05.362868Z","steps":["trace[357055987] 'process raft request' (duration: 198.426505ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:05.36311Z","caller":"traceutil/trace.go:171","msg":"trace[936904087] transaction","detail":"{read_only:false; response_revision:529; number_of_response:1; }","duration":"203.183563ms","start":"2026-05-27T05:59:05.159838Z","end":"2026-05-27T05:59:05.363021Z","steps":["trace[936904087] 'process raft request' (duration: 202.70693ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:11.186721Z","caller":"traceutil/trace.go:171","msg":"trace[1617402893] linearizableReadLoop","detail":"{readStateIndex:631; appliedIndex:630; }","duration":"416.58764ms","start":"2026-05-27T05:59:10.770076Z","end":"2026-05-27T05:59:11.186664Z","steps":["trace[1617402893] 'read index received' (duration: 390.971457ms)","trace[1617402893] 'applied index is now lower than readState.Index' (duration: 25.615263ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:11.186853Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"416.775466ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:11.186874Z","caller":"traceutil/trace.go:171","msg":"trace[568620076] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:607; }","duration":"416.884518ms","start":"2026-05-27T05:59:10.769982Z","end":"2026-05-27T05:59:11.186866Z","steps":["trace[568620076] 'agreement among raft nodes before linearized reading' (duration: 416.811727ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:11.186897Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:10.769939Z","time spent":"416.95412ms","remote":"127.0.0.1:52246","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-05-27T05:59:11.18686Z","caller":"traceutil/trace.go:171","msg":"trace[664467906] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"550.868112ms","start":"2026-05-27T05:59:10.635945Z","end":"2026-05-27T05:59:11.186813Z","steps":["trace[664467906] 'process raft request' (duration: 526.470651ms)","trace[664467906] 'compare' (duration: 23.765525ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:11.187053Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:10.635927Z","time spent":"551.043746ms","remote":"127.0.0.1:52336","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036019,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:59:11.810443Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"289.129778ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:59:11.810527Z","caller":"traceutil/trace.go:171","msg":"trace[935986770] linearizableReadLoop","detail":"{readStateIndex:632; appliedIndex:631; }","duration":"623.739771ms","start":"2026-05-27T05:59:11.186774Z","end":"2026-05-27T05:59:11.810514Z","steps":["trace[935986770] 'read index received' (duration: 334.094069ms)","trace[935986770] 'applied index is now lower than readState.Index' (duration: 289.644642ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:11.810606Z","caller":"traceutil/trace.go:171","msg":"trace[163691565] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"748.380416ms","start":"2026-05-27T05:59:11.062217Z","end":"2026-05-27T05:59:11.810597Z","steps":["trace[163691565] 'process raft request' (duration: 458.764035ms)","trace[163691565] 'compare' (duration: 288.874721ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:11.810656Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.062183Z","time spent":"748.451807ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:11.810767Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"622.94029ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-27T05:59:11.810796Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"688.855432ms","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-05-27T05:59:11.810847Z","caller":"traceutil/trace.go:171","msg":"trace[1596515511] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:608; }","duration":"623.058813ms","start":"2026-05-27T05:59:11.187764Z","end":"2026-05-27T05:59:11.810823Z","steps":["trace[1596515511] 'agreement among raft nodes before linearized reading' (duration: 622.914609ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:11.810866Z","caller":"traceutil/trace.go:171","msg":"trace[928699121] range","detail":"{range_begin:/registry/masterleases/199.204.45.65; range_end:; response_count:1; response_revision:608; }","duration":"688.973955ms","start":"2026-05-27T05:59:11.121869Z","end":"2026-05-27T05:59:11.810843Z","steps":["trace[928699121] 'agreement among raft nodes before linearized reading' (duration: 688.833451ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:11.810892Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.187745Z","time spent":"623.139006ms","remote":"127.0.0.1:52250","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-05-27T05:59:11.810903Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.121809Z","time spent":"689.085368ms","remote":"127.0.0.1:52286","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.65\" "} {"level":"warn","ts":"2026-05-27T05:59:11.810963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"558.821415ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:11.811106Z","caller":"traceutil/trace.go:171","msg":"trace[156442885] range","detail":"{range_begin:/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:608; }","duration":"559.065801ms","start":"2026-05-27T05:59:11.252001Z","end":"2026-05-27T05:59:11.811066Z","steps":["trace[156442885] 'agreement among raft nodes before linearized reading' (duration: 558.762944ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:11.811159Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.251962Z","time spent":"559.184644ms","remote":"127.0.0.1:52450","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":0,"response size":29,"request content":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-05-27T05:59:12.189611Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.466428ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:41"} {"level":"warn","ts":"2026-05-27T05:59:12.190038Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.812467Z","time spent":"377.567223ms","remote":"127.0.0.1:52286","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-05-27T05:59:12.1901Z","caller":"traceutil/trace.go:171","msg":"trace[1877844736] linearizableReadLoop","detail":"{readStateIndex:633; appliedIndex:632; }","duration":"365.732251ms","start":"2026-05-27T05:59:11.824352Z","end":"2026-05-27T05:59:12.190084Z","steps":["trace[1877844736] 'read index received' (duration: 126.769611ms)","trace[1877844736] 'applied index is now lower than readState.Index' (duration: 238.96095ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:12.190236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"365.883355ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:12.190273Z","caller":"traceutil/trace.go:171","msg":"trace[1513406815] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:608; }","duration":"365.925646ms","start":"2026-05-27T05:59:11.824338Z","end":"2026-05-27T05:59:12.190263Z","steps":["trace[1513406815] 'agreement among raft nodes before linearized reading' (duration: 365.848674ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:12.190295Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.824284Z","time spent":"366.005738ms","remote":"127.0.0.1:52246","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-05-27T05:59:12.191152Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.750778ms","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-05-27T05:59:12.191218Z","caller":"traceutil/trace.go:171","msg":"trace[663756631] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:608; }","duration":"275.84281ms","start":"2026-05-27T05:59:11.91536Z","end":"2026-05-27T05:59:12.191203Z","steps":["trace[663756631] 'agreement among raft nodes before linearized reading' (duration: 275.680296ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:12.191336Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.362875ms","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-27T05:59:12.191369Z","caller":"traceutil/trace.go:171","msg":"trace[1146592199] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:608; }","duration":"305.433027ms","start":"2026-05-27T05:59:11.885928Z","end":"2026-05-27T05:59:12.191361Z","steps":["trace[1146592199] 'agreement among raft nodes before linearized reading' (duration: 305.355195ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:12.19139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:11.885908Z","time spent":"305.476538ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-05-27T05:59:13.307731Z","caller":"traceutil/trace.go:171","msg":"trace[1331408337] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"699.489582ms","start":"2026-05-27T05:59:12.608216Z","end":"2026-05-27T05:59:13.307706Z","steps":["trace[1331408337] 'process raft request' (duration: 699.285897ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:13.307885Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:12.608191Z","time spent":"699.619455ms","remote":"127.0.0.1:52504","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-05-27T05:59:14.526693Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.217461751s","expected-duration":"1s"} {"level":"info","ts":"2026-05-27T05:59:14.527773Z","caller":"traceutil/trace.go:171","msg":"trace[466272992] linearizableReadLoop","detail":"{readStateIndex:644; appliedIndex:642; }","duration":"1.425880926s","start":"2026-05-27T05:59:13.101867Z","end":"2026-05-27T05:59:14.527748Z","steps":["trace[466272992] 'read index received' (duration: 205.697484ms)","trace[466272992] 'applied index is now lower than readState.Index' (duration: 1.220182412s)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:14.527853Z","caller":"traceutil/trace.go:171","msg":"trace[413862851] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"1.801990824s","start":"2026-05-27T05:59:12.725821Z","end":"2026-05-27T05:59:14.527812Z","steps":["trace[413862851] 'process raft request' (duration: 1.801383317s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.527934Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.426051371s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-v78wr\" ","response":"range_response_count:1 size:16961"} {"level":"info","ts":"2026-05-27T05:59:14.527986Z","caller":"traceutil/trace.go:171","msg":"trace[1513034066] range","detail":"{range_begin:/registry/pods/kube-system/cilium-v78wr; range_end:; response_count:1; response_revision:619; }","duration":"1.426150074s","start":"2026-05-27T05:59:13.101819Z","end":"2026-05-27T05:59:14.527969Z","steps":["trace[1513034066] 'agreement among raft nodes before linearized reading' (duration: 1.426052761s)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.52802Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:12.725794Z","time spent":"1.802145048s","remote":"127.0.0.1:52336","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036161,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:14.528044Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:13.101799Z","time spent":"1.426231675s","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16985,"request content":"key:\"/registry/pods/kube-system/cilium-v78wr\" "} {"level":"info","ts":"2026-05-27T05:59:14.552151Z","caller":"traceutil/trace.go:171","msg":"trace[472584942] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"540.191605ms","start":"2026-05-27T05:59:14.011937Z","end":"2026-05-27T05:59:14.552129Z","steps":["trace[472584942] 'process raft request' (duration: 539.969099ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.552464Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:14.011903Z","time spent":"540.507653ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:14.552149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"785.518113ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:14.552553Z","caller":"traceutil/trace.go:171","msg":"trace[969596313] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:620; }","duration":"785.970405ms","start":"2026-05-27T05:59:13.766564Z","end":"2026-05-27T05:59:14.552534Z","steps":["trace[969596313] 'agreement among raft nodes before linearized reading' (duration: 785.485292ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.552252Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.399316ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"warn","ts":"2026-05-27T05:59:14.552618Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:13.766525Z","time spent":"786.082268ms","remote":"127.0.0.1:52246","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-05-27T05:59:14.552642Z","caller":"traceutil/trace.go:171","msg":"trace[20723236] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:620; }","duration":"287.819779ms","start":"2026-05-27T05:59:14.264811Z","end":"2026-05-27T05:59:14.55263Z","steps":["trace[20723236] 'agreement among raft nodes before linearized reading' (duration: 287.363366ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.552292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.04947ms","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-27T05:59:14.552711Z","caller":"traceutil/trace.go:171","msg":"trace[1787498395] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:620; }","duration":"294.565385ms","start":"2026-05-27T05:59:14.258139Z","end":"2026-05-27T05:59:14.552705Z","steps":["trace[1787498395] 'agreement among raft nodes before linearized reading' (duration: 293.980649ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.552937Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.734852ms","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-05-27T05:59:14.552993Z","caller":"traceutil/trace.go:171","msg":"trace[1692440698] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:620; }","duration":"293.827925ms","start":"2026-05-27T05:59:14.259155Z","end":"2026-05-27T05:59:14.552983Z","steps":["trace[1692440698] 'agreement among raft nodes before linearized reading' (duration: 292.90705ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:14.657237Z","caller":"traceutil/trace.go:171","msg":"trace[2133849102] linearizableReadLoop","detail":"{readStateIndex:646; appliedIndex:645; }","duration":"103.314325ms","start":"2026-05-27T05:59:14.553904Z","end":"2026-05-27T05:59:14.657219Z","steps":["trace[2133849102] 'read index received' (duration: 103.236873ms)","trace[2133849102] 'applied index is now lower than readState.Index' (duration: 76.682µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:14.657298Z","caller":"traceutil/trace.go:171","msg":"trace[802661222] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"116.847146ms","start":"2026-05-27T05:59:14.540421Z","end":"2026-05-27T05:59:14.657269Z","steps":["trace[802661222] 'process raft request' (duration: 116.678412ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:14.65736Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.431638ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:14.65744Z","caller":"traceutil/trace.go:171","msg":"trace[1843437376] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:621; }","duration":"103.51938ms","start":"2026-05-27T05:59:14.553899Z","end":"2026-05-27T05:59:14.657419Z","steps":["trace[1843437376] 'agreement among raft nodes before linearized reading' (duration: 103.389387ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:14.665296Z","caller":"traceutil/trace.go:171","msg":"trace[634489234] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"109.080624ms","start":"2026-05-27T05:59:14.556196Z","end":"2026-05-27T05:59:14.665277Z","steps":["trace[634489234] 'process raft request' (duration: 108.90804ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:14.665415Z","caller":"traceutil/trace.go:171","msg":"trace[897480455] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"109.045613ms","start":"2026-05-27T05:59:14.556347Z","end":"2026-05-27T05:59:14.665393Z","steps":["trace[897480455] 'process raft request' (duration: 108.788777ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:14.665275Z","caller":"traceutil/trace.go:171","msg":"trace[1745322972] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"109.165266ms","start":"2026-05-27T05:59:14.556056Z","end":"2026-05-27T05:59:14.665221Z","steps":["trace[1745322972] 'process raft request' (duration: 108.95083ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:15.361784Z","caller":"traceutil/trace.go:171","msg":"trace[1929618194] transaction","detail":"{read_only:false; response_revision:629; number_of_response:1; }","duration":"197.601615ms","start":"2026-05-27T05:59:15.164147Z","end":"2026-05-27T05:59:15.361748Z","steps":["trace[1929618194] 'process raft request' (duration: 169.468067ms)","trace[1929618194] 'compare' (duration: 27.494532ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:16.557165Z","caller":"traceutil/trace.go:171","msg":"trace[1059329397] transaction","detail":"{read_only:false; response_revision:642; number_of_response:1; }","duration":"287.621898ms","start":"2026-05-27T05:59:16.269524Z","end":"2026-05-27T05:59:16.557146Z","steps":["trace[1059329397] 'process raft request' (duration: 287.520135ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:16.569488Z","caller":"traceutil/trace.go:171","msg":"trace[2036973426] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"274.13141ms","start":"2026-05-27T05:59:16.295341Z","end":"2026-05-27T05:59:16.569473Z","steps":["trace[2036973426] 'process raft request' (duration: 273.534284ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:20.868834Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.304856ms","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-27T05:59:20.86891Z","caller":"traceutil/trace.go:171","msg":"trace[933265447] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:717; }","duration":"177.408138ms","start":"2026-05-27T05:59:20.691487Z","end":"2026-05-27T05:59:20.868895Z","steps":["trace[933265447] 'range keys from in-memory index tree' (duration: 177.153892ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:20.869Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.444589ms","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-27T05:59:20.869067Z","caller":"traceutil/trace.go:171","msg":"trace[1887010902] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:717; }","duration":"177.523971ms","start":"2026-05-27T05:59:20.691531Z","end":"2026-05-27T05:59:20.869055Z","steps":["trace[1887010902] 'range keys from in-memory index tree' (duration: 177.281276ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:20.869002Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.461346ms","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-05-27T05:59:20.86952Z","caller":"traceutil/trace.go:171","msg":"trace[85726563] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:717; }","duration":"180.946398ms","start":"2026-05-27T05:59:20.688464Z","end":"2026-05-27T05:59:20.869411Z","steps":["trace[85726563] 'range keys from in-memory index tree' (duration: 180.261661ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:20.875245Z","caller":"traceutil/trace.go:171","msg":"trace[2110479574] linearizableReadLoop","detail":"{readStateIndex:744; appliedIndex:743; }","duration":"110.583281ms","start":"2026-05-27T05:59:20.764651Z","end":"2026-05-27T05:59:20.875234Z","steps":["trace[2110479574] 'read index received' (duration: 110.498958ms)","trace[2110479574] 'applied index is now lower than readState.Index' (duration: 83.753µs)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:20.875434Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.777675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" ","response":"range_response_count:1 size:13229"} {"level":"info","ts":"2026-05-27T05:59:20.875466Z","caller":"traceutil/trace.go:171","msg":"trace[1667534967] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io; range_end:; response_count:1; response_revision:718; }","duration":"110.842607ms","start":"2026-05-27T05:59:20.764614Z","end":"2026-05-27T05:59:20.875456Z","steps":["trace[1667534967] 'agreement among raft nodes before linearized reading' (duration: 110.668103ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:20.875959Z","caller":"traceutil/trace.go:171","msg":"trace[1484343488] transaction","detail":"{read_only:false; response_revision:718; number_of_response:1; }","duration":"165.400734ms","start":"2026-05-27T05:59:20.71055Z","end":"2026-05-27T05:59:20.875951Z","steps":["trace[1484343488] 'process raft request' (duration: 164.522041ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:21.288767Z","caller":"traceutil/trace.go:171","msg":"trace[1678535469] transaction","detail":"{read_only:false; response_revision:719; number_of_response:1; }","duration":"416.772946ms","start":"2026-05-27T05:59:20.871956Z","end":"2026-05-27T05:59:21.288729Z","steps":["trace[1678535469] 'process raft request' (duration: 393.841605ms)","trace[1678535469] 'compare' (duration: 22.303835ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:21.288804Z","caller":"traceutil/trace.go:171","msg":"trace[1302895720] linearizableReadLoop","detail":"{readStateIndex:747; appliedIndex:744; }","duration":"384.378382ms","start":"2026-05-27T05:59:20.904403Z","end":"2026-05-27T05:59:21.288781Z","steps":["trace[1302895720] 'read index received' (duration: 361.408301ms)","trace[1302895720] 'applied index is now lower than readState.Index' (duration: 22.968741ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:21.288872Z","caller":"traceutil/trace.go:171","msg":"trace[56338741] transaction","detail":"{read_only:false; response_revision:720; number_of_response:1; }","duration":"416.786896ms","start":"2026-05-27T05:59:20.872052Z","end":"2026-05-27T05:59:21.288838Z","steps":["trace[56338741] 'process raft request' (duration: 416.631413ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.288934Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.871941Z","time spent":"416.90849ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:59:21.288899Z","caller":"traceutil/trace.go:171","msg":"trace[2031622044] transaction","detail":"{read_only:false; response_revision:721; number_of_response:1; }","duration":"414.747665ms","start":"2026-05-27T05:59:20.874142Z","end":"2026-05-27T05:59:21.288889Z","steps":["trace[2031622044] 'process raft request' (duration: 414.602541ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.289045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.615038ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"warn","ts":"2026-05-27T05:59:21.289071Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.872047Z","time spent":"416.92919ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:21.28909Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.874134Z","time spent":"414.850337ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:59:21.289124Z","caller":"traceutil/trace.go:171","msg":"trace[2013187324] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:721; }","duration":"384.741271ms","start":"2026-05-27T05:59:20.904365Z","end":"2026-05-27T05:59:21.289107Z","steps":["trace[2013187324] 'agreement among raft nodes before linearized reading' (duration: 384.547476ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.289167Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.904348Z","time spent":"384.811513ms","remote":"127.0.0.1:52350","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":1,"response size":375,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-27T05:59:21.591845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.595594ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:59:21.592003Z","caller":"traceutil/trace.go:171","msg":"trace[2035201085] linearizableReadLoop","detail":"{readStateIndex:748; appliedIndex:747; }","duration":"303.126316ms","start":"2026-05-27T05:59:21.288862Z","end":"2026-05-27T05:59:21.591988Z","steps":["trace[2035201085] 'read index received' (duration: 103.06463ms)","trace[2035201085] 'applied index is now lower than readState.Index' (duration: 200.060396ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:21.592097Z","caller":"traceutil/trace.go:171","msg":"trace[498429958] transaction","detail":"{read_only:false; response_revision:722; number_of_response:1; }","duration":"644.365232ms","start":"2026-05-27T05:59:20.947701Z","end":"2026-05-27T05:59:21.592066Z","steps":["trace[498429958] 'process raft request' (duration: 444.353657ms)","trace[498429958] 'compare' (duration: 199.401979ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:21.592248Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.947665Z","time spent":"644.499775ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":188480,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:21.59231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.336006ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/instance\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.59232Z","caller":"traceutil/trace.go:171","msg":"trace[584645522] transaction","detail":"{read_only:false; response_revision:723; number_of_response:1; }","duration":"191.312534ms","start":"2026-05-27T05:59:21.400966Z","end":"2026-05-27T05:59:21.592279Z","steps":["trace[584645522] 'process raft request' (duration: 190.974965ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:21.592363Z","caller":"traceutil/trace.go:171","msg":"trace[691013972] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/instance; range_end:; response_count:0; response_revision:723; }","duration":"197.41309ms","start":"2026-05-27T05:59:21.394937Z","end":"2026-05-27T05:59:21.59235Z","steps":["trace[691013972] 'agreement among raft nodes before linearized reading' (duration: 197.331867ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.592447Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.44339ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.592514Z","caller":"traceutil/trace.go:171","msg":"trace[1721223023] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:723; }","duration":"197.515211ms","start":"2026-05-27T05:59:21.394988Z","end":"2026-05-27T05:59:21.592503Z","steps":["trace[1721223023] 'agreement among raft nodes before linearized reading' (duration: 197.431209ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.592609Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.615985ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.59265Z","caller":"traceutil/trace.go:171","msg":"trace[1514377724] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:723; }","duration":"197.662386ms","start":"2026-05-27T05:59:21.394975Z","end":"2026-05-27T05:59:21.592637Z","steps":["trace[1514377724] 'agreement among raft nodes before linearized reading' (duration: 197.605634ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.592355Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"427.158277ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io\" ","response":"range_response_count:1 size:188495"} {"level":"warn","ts":"2026-05-27T05:59:21.592649Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.900073ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-27T05:59:21.592748Z","caller":"traceutil/trace.go:171","msg":"trace[194305860] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io; range_end:; response_count:1; response_revision:723; }","duration":"427.590328ms","start":"2026-05-27T05:59:21.165149Z","end":"2026-05-27T05:59:21.59274Z","steps":["trace[194305860] 'agreement among raft nodes before linearized reading' (duration: 426.979952ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.592783Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.165131Z","time spent":"427.643509ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":1,"response size":188519,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io\" "} {"level":"info","ts":"2026-05-27T05:59:21.592797Z","caller":"traceutil/trace.go:171","msg":"trace[1616618151] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:723; }","duration":"157.067317ms","start":"2026-05-27T05:59:21.435685Z","end":"2026-05-27T05:59:21.592752Z","steps":["trace[1616618151] 'agreement among raft nodes before linearized reading' (duration: 156.78484ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.592826Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"628.206012ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" ","response":"range_response_count:1 size:188252"} {"level":"info","ts":"2026-05-27T05:59:21.592881Z","caller":"traceutil/trace.go:171","msg":"trace[1825797029] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io; range_end:; response_count:1; response_revision:723; }","duration":"628.289924ms","start":"2026-05-27T05:59:20.964575Z","end":"2026-05-27T05:59:21.592865Z","steps":["trace[1825797029] 'agreement among raft nodes before linearized reading' (duration: 627.555844ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.59292Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:20.964562Z","time spent":"628.349606ms","remote":"127.0.0.1:52304","response type":"/etcdserverpb.KV/Range","request count":0,"request size":90,"response count":1,"response size":188276,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" "} {"level":"warn","ts":"2026-05-27T05:59:21.592763Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"470.32969ms","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-05-27T05:59:21.59311Z","caller":"traceutil/trace.go:171","msg":"trace[952080030] range","detail":"{range_begin:/registry/masterleases/199.204.45.65; range_end:; response_count:1; response_revision:723; }","duration":"470.761101ms","start":"2026-05-27T05:59:21.122317Z","end":"2026-05-27T05:59:21.593079Z","steps":["trace[952080030] 'agreement among raft nodes before linearized reading' (duration: 469.788936ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.593217Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"424.258944ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-v78wr\" ","response":"range_response_count:1 size:18512"} {"level":"info","ts":"2026-05-27T05:59:21.593269Z","caller":"traceutil/trace.go:171","msg":"trace[1916536251] range","detail":"{range_begin:/registry/pods/kube-system/cilium-v78wr; range_end:; response_count:1; response_revision:723; }","duration":"424.349866ms","start":"2026-05-27T05:59:21.168909Z","end":"2026-05-27T05:59:21.593259Z","steps":["trace[1916536251] 'agreement among raft nodes before linearized reading' (duration: 423.116074ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.593297Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.168898Z","time spent":"424.392897ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":18536,"request content":"key:\"/registry/pods/kube-system/cilium-v78wr\" "} {"level":"warn","ts":"2026-05-27T05:59:21.593248Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.122297Z","time spent":"470.931895ms","remote":"127.0.0.1:52286","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.65\" "} {"level":"info","ts":"2026-05-27T05:59:21.911244Z","caller":"traceutil/trace.go:171","msg":"trace[333772188] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"313.100108ms","start":"2026-05-27T05:59:21.598126Z","end":"2026-05-27T05:59:21.911226Z","steps":["trace[333772188] 'process raft request' (duration: 233.368939ms)","trace[333772188] 'compare' (duration: 79.37961ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:21.911351Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.598087Z","time spent":"313.21075ms","remote":"127.0.0.1:52504","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-05-27T05:59:21.911515Z","caller":"traceutil/trace.go:171","msg":"trace[1039202313] transaction","detail":"{read_only:false; response_revision:726; number_of_response:1; }","duration":"303.850974ms","start":"2026-05-27T05:59:21.607637Z","end":"2026-05-27T05:59:21.911487Z","steps":["trace[1039202313] 'process raft request' (duration: 303.553557ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:21.911475Z","caller":"traceutil/trace.go:171","msg":"trace[1046325349] transaction","detail":"{read_only:false; response_revision:725; number_of_response:1; }","duration":"308.121943ms","start":"2026-05-27T05:59:21.603312Z","end":"2026-05-27T05:59:21.911434Z","steps":["trace[1046325349] 'process raft request' (duration: 307.838866ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.911676Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.603297Z","time spent":"308.320317ms","remote":"127.0.0.1:52320","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":614,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-27T05:59:21.911704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.607616Z","time spent":"303.981317ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":18694,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:59:21.911797Z","caller":"traceutil/trace.go:171","msg":"trace[398229373] transaction","detail":"{read_only:false; response_revision:727; number_of_response:1; }","duration":"303.462966ms","start":"2026-05-27T05:59:21.608324Z","end":"2026-05-27T05:59:21.911787Z","steps":["trace[398229373] 'process raft request' (duration: 303.066475ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.911844Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.608315Z","time spent":"303.505826ms","remote":"127.0.0.1:52406","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4308,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:59:21.912057Z","caller":"traceutil/trace.go:171","msg":"trace[2001339567] linearizableReadLoop","detail":"{readStateIndex:755; appliedIndex:750; }","duration":"138.725163ms","start":"2026-05-27T05:59:21.773323Z","end":"2026-05-27T05:59:21.912048Z","steps":["trace[2001339567] 'read index received' (duration: 58.158953ms)","trace[2001339567] 'applied index is now lower than readState.Index' (duration: 80.56539ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:21.91211Z","caller":"traceutil/trace.go:171","msg":"trace[1839371288] transaction","detail":"{read_only:false; response_revision:728; number_of_response:1; }","duration":"302.530052ms","start":"2026-05-27T05:59:21.609574Z","end":"2026-05-27T05:59:21.912104Z","steps":["trace[1839371288] 'process raft request' (duration: 302.163652ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.912186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:21.609544Z","time spent":"302.610393ms","remote":"127.0.0.1:52286","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":118,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:21.912305Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.988269ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.912331Z","caller":"traceutil/trace.go:171","msg":"trace[2030377117] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:728; }","duration":"139.037481ms","start":"2026-05-27T05:59:21.773287Z","end":"2026-05-27T05:59:21.912325Z","steps":["trace[2030377117] 'agreement among raft nodes before linearized reading' (duration: 138.98623ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.979753Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.19207ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumendpoints/\" range_end:\"/registry/cilium.io/ciliumendpoints0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-27T05:59:21.979779Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.671743ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumendpoints/\" range_end:\"/registry/cilium.io/ciliumendpoints0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.979831Z","caller":"traceutil/trace.go:171","msg":"trace[139127474] range","detail":"{range_begin:/registry/cilium.io/ciliumendpoints/; range_end:/registry/cilium.io/ciliumendpoints0; response_count:0; response_revision:728; }","duration":"202.295203ms","start":"2026-05-27T05:59:21.777521Z","end":"2026-05-27T05:59:21.979816Z","steps":["trace[139127474] 'agreement among raft nodes before linearized reading' (duration: 202.117618ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.979827Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.763099ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.979846Z","caller":"traceutil/trace.go:171","msg":"trace[535832170] range","detail":"{range_begin:/registry/cilium.io/ciliumendpoints/; range_end:/registry/cilium.io/ciliumendpoints0; response_count:0; response_revision:728; }","duration":"202.743374ms","start":"2026-05-27T05:59:21.777086Z","end":"2026-05-27T05:59:21.979829Z","steps":["trace[535832170] 'agreement among raft nodes before linearized reading' (duration: 202.672352ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:21.979896Z","caller":"traceutil/trace.go:171","msg":"trace[83650474] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:728; }","duration":"186.892162ms","start":"2026-05-27T05:59:21.792985Z","end":"2026-05-27T05:59:21.979877Z","steps":["trace[83650474] 'agreement among raft nodes before linearized reading' (duration: 186.735228ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.979753Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.672307ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.980028Z","caller":"traceutil/trace.go:171","msg":"trace[1752783211] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:728; }","duration":"186.982835ms","start":"2026-05-27T05:59:21.793037Z","end":"2026-05-27T05:59:21.980019Z","steps":["trace[1752783211] 'agreement among raft nodes before linearized reading' (duration: 186.587355ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.979761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.435541ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.980092Z","caller":"traceutil/trace.go:171","msg":"trace[1885535039] transaction","detail":"{read_only:false; number_of_response:1; response_revision:728; }","duration":"109.484373ms","start":"2026-05-27T05:59:21.8706Z","end":"2026-05-27T05:59:21.980084Z","steps":["trace[1885535039] 'process raft request' (duration: 108.872977ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:21.98013Z","caller":"traceutil/trace.go:171","msg":"trace[1534321378] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:728; }","duration":"186.79477ms","start":"2026-05-27T05:59:21.793284Z","end":"2026-05-27T05:59:21.980079Z","steps":["trace[1534321378] 'agreement among raft nodes before linearized reading' (duration: 186.328939ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:21.97977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.57057ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumendpoints/\" range_end:\"/registry/cilium.io/ciliumendpoints0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:21.980348Z","caller":"traceutil/trace.go:171","msg":"trace[1222235804] range","detail":"{range_begin:/registry/cilium.io/ciliumendpoints/; range_end:/registry/cilium.io/ciliumendpoints0; response_count:0; response_revision:728; }","duration":"203.143495ms","start":"2026-05-27T05:59:21.777149Z","end":"2026-05-27T05:59:21.980293Z","steps":["trace[1222235804] 'agreement among raft nodes before linearized reading' (duration: 202.53751ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:22.043007Z","caller":"traceutil/trace.go:171","msg":"trace[498238743] transaction","detail":"{read_only:false; response_revision:729; number_of_response:1; }","duration":"117.354118ms","start":"2026-05-27T05:59:21.925629Z","end":"2026-05-27T05:59:22.042983Z","steps":["trace[498238743] 'process raft request' (duration: 113.476911ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:22.043073Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.800083ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:22.043137Z","caller":"traceutil/trace.go:171","msg":"trace[1291431937] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:730; }","duration":"129.896916ms","start":"2026-05-27T05:59:21.913222Z","end":"2026-05-27T05:59:22.043119Z","steps":["trace[1291431937] 'agreement among raft nodes before linearized reading' (duration: 129.779503ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:22.043188Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.954432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" limit:10 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-27T05:59:22.043337Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.353761ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:22.043378Z","caller":"traceutil/trace.go:171","msg":"trace[877214963] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:730; }","duration":"112.166348ms","start":"2026-05-27T05:59:21.931199Z","end":"2026-05-27T05:59:22.043365Z","steps":["trace[877214963] 'agreement among raft nodes before linearized reading' (duration: 111.937961ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:22.043391Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.337951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:22.043427Z","caller":"traceutil/trace.go:171","msg":"trace[1915450664] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:730; }","duration":"112.476356ms","start":"2026-05-27T05:59:21.930927Z","end":"2026-05-27T05:59:22.043403Z","steps":["trace[1915450664] 'agreement among raft nodes before linearized reading' (duration: 112.324061ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:22.043482Z","caller":"traceutil/trace.go:171","msg":"trace[1644958381] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:730; }","duration":"112.460075ms","start":"2026-05-27T05:59:21.930999Z","end":"2026-05-27T05:59:22.043459Z","steps":["trace[1644958381] 'agreement among raft nodes before linearized reading' (duration: 112.2883ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:22.043881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.161147ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/default/kubernetes\" ","response":"range_response_count:1 size:421"} {"level":"info","ts":"2026-05-27T05:59:22.045671Z","caller":"traceutil/trace.go:171","msg":"trace[1833886458] range","detail":"{range_begin:/registry/services/endpoints/default/kubernetes; range_end:; response_count:1; response_revision:730; }","duration":"130.956342ms","start":"2026-05-27T05:59:21.914699Z","end":"2026-05-27T05:59:22.045655Z","steps":["trace[1833886458] 'agreement among raft nodes before linearized reading' (duration: 128.648753ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:25.966085Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.111713ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:59:25.966212Z","caller":"traceutil/trace.go:171","msg":"trace[560580388] transaction","detail":"{read_only:false; response_revision:759; number_of_response:1; }","duration":"270.694637ms","start":"2026-05-27T05:59:25.695494Z","end":"2026-05-27T05:59:25.966189Z","steps":["trace[560580388] 'process raft request' (duration: 16.358989ms)","trace[560580388] 'compare' (duration: 253.836696ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:25.973773Z","caller":"traceutil/trace.go:171","msg":"trace[819709783] linearizableReadLoop","detail":"{readStateIndex:790; appliedIndex:789; }","duration":"204.880855ms","start":"2026-05-27T05:59:25.768873Z","end":"2026-05-27T05:59:25.973754Z","steps":["trace[819709783] 'read index received' (duration: 204.811613ms)","trace[819709783] 'applied index is now lower than readState.Index' (duration: 68.402µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:25.973869Z","caller":"traceutil/trace.go:171","msg":"trace[1024409677] transaction","detail":"{read_only:false; response_revision:760; number_of_response:1; }","duration":"274.795209ms","start":"2026-05-27T05:59:25.699043Z","end":"2026-05-27T05:59:25.973838Z","steps":["trace[1024409677] 'process raft request' (duration: 274.602874ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:25.973892Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.001448ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:25.973921Z","caller":"traceutil/trace.go:171","msg":"trace[887606464] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:760; }","duration":"205.08083ms","start":"2026-05-27T05:59:25.768833Z","end":"2026-05-27T05:59:25.973913Z","steps":["trace[887606464] 'agreement among raft nodes before linearized reading' (duration: 205.020099ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:26.229591Z","caller":"traceutil/trace.go:171","msg":"trace[593921708] linearizableReadLoop","detail":"{readStateIndex:791; appliedIndex:790; }","duration":"255.725223ms","start":"2026-05-27T05:59:25.973834Z","end":"2026-05-27T05:59:26.229559Z","steps":["trace[593921708] 'read index received' (duration: 237.102559ms)","trace[593921708] 'applied index is now lower than readState.Index' (duration: 18.621264ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:26.229819Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.575054ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:26.229849Z","caller":"traceutil/trace.go:171","msg":"trace[1200521833] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:761; }","duration":"254.660107ms","start":"2026-05-27T05:59:25.97518Z","end":"2026-05-27T05:59:26.22984Z","steps":["trace[1200521833] 'agreement among raft nodes before linearized reading' (duration: 254.583995ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:26.229803Z","caller":"traceutil/trace.go:171","msg":"trace[1735283173] transaction","detail":"{read_only:false; response_revision:761; number_of_response:1; }","duration":"256.460271ms","start":"2026-05-27T05:59:25.973289Z","end":"2026-05-27T05:59:26.229749Z","steps":["trace[1735283173] 'process raft request' (duration: 237.665984ms)","trace[1735283173] 'compare' (duration: 18.254644ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:26.230169Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.260825ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-27T05:59:26.230257Z","caller":"traceutil/trace.go:171","msg":"trace[1871187002] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:761; }","duration":"304.430189ms","start":"2026-05-27T05:59:25.925807Z","end":"2026-05-27T05:59:26.230237Z","steps":["trace[1871187002] 'agreement among raft nodes before linearized reading' (duration: 303.911857ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:26.230343Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:25.925765Z","time spent":"304.544832ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-05-27T05:59:31.639213Z","caller":"traceutil/trace.go:171","msg":"trace[1363125105] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"294.424545ms","start":"2026-05-27T05:59:31.344754Z","end":"2026-05-27T05:59:31.639179Z","steps":["trace[1363125105] 'process raft request' (duration: 294.168519ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:31.639406Z","caller":"traceutil/trace.go:171","msg":"trace[1683058664] transaction","detail":"{read_only:false; response_revision:783; number_of_response:1; }","duration":"294.60985ms","start":"2026-05-27T05:59:31.344754Z","end":"2026-05-27T05:59:31.639364Z","steps":["trace[1683058664] 'process raft request' (duration: 294.383704ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:31.643232Z","caller":"traceutil/trace.go:171","msg":"trace[367511835] transaction","detail":"{read_only:false; response_revision:784; number_of_response:1; }","duration":"297.223213ms","start":"2026-05-27T05:59:31.345975Z","end":"2026-05-27T05:59:31.643198Z","steps":["trace[367511835] 'process raft request' (duration: 297.047569ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:34.844253Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8620626806309659054,"retry-timeout":"500ms"} {"level":"info","ts":"2026-05-27T05:59:34.951152Z","caller":"traceutil/trace.go:171","msg":"trace[535959828] linearizableReadLoop","detail":"{readStateIndex:838; appliedIndex:837; }","duration":"607.289769ms","start":"2026-05-27T05:59:34.343833Z","end":"2026-05-27T05:59:34.951123Z","steps":["trace[535959828] 'read index received' (duration: 607.174436ms)","trace[535959828] 'applied index is now lower than readState.Index' (duration: 114.113µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:34.951216Z","caller":"traceutil/trace.go:171","msg":"trace[2109346225] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"723.764236ms","start":"2026-05-27T05:59:34.22743Z","end":"2026-05-27T05:59:34.951195Z","steps":["trace[2109346225] 'process raft request' (duration: 723.52474ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:34.951422Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.424306ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-27T05:59:34.951454Z","caller":"traceutil/trace.go:171","msg":"trace[1848482202] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:805; }","duration":"171.520648ms","start":"2026-05-27T05:59:34.779923Z","end":"2026-05-27T05:59:34.951444Z","steps":["trace[1848482202] 'agreement among raft nodes before linearized reading' (duration: 171.377194ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:34.951463Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:34.227404Z","time spent":"723.870779ms","remote":"127.0.0.1:52484","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-05-27T05:59:34.951598Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"607.697738ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-27T05:59:34.951733Z","caller":"traceutil/trace.go:171","msg":"trace[76682580] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:805; }","duration":"607.902483ms","start":"2026-05-27T05:59:34.343771Z","end":"2026-05-27T05:59:34.951673Z","steps":["trace[76682580] 'agreement among raft nodes before linearized reading' (duration: 607.515764ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:34.951826Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:34.343745Z","time spent":"608.065288ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-05-27T05:59:35.208591Z","caller":"traceutil/trace.go:171","msg":"trace[1356946353] transaction","detail":"{read_only:false; response_revision:806; number_of_response:1; }","duration":"249.778785ms","start":"2026-05-27T05:59:34.958786Z","end":"2026-05-27T05:59:35.208565Z","steps":["trace[1356946353] 'process raft request' (duration: 249.657352ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:35.216795Z","caller":"traceutil/trace.go:171","msg":"trace[2084157105] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"257.612654ms","start":"2026-05-27T05:59:34.959135Z","end":"2026-05-27T05:59:35.216748Z","steps":["trace[2084157105] 'process raft request' (duration: 257.45962ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:35.217259Z","caller":"traceutil/trace.go:171","msg":"trace[712303954] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"136.600203ms","start":"2026-05-27T05:59:35.080624Z","end":"2026-05-27T05:59:35.217224Z","steps":["trace[712303954] 'process raft request' (duration: 136.061471ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:41.863632Z","caller":"traceutil/trace.go:171","msg":"trace[1534853275] transaction","detail":"{read_only:false; response_revision:875; number_of_response:1; }","duration":"113.42546ms","start":"2026-05-27T05:59:41.750163Z","end":"2026-05-27T05:59:41.863588Z","steps":["trace[1534853275] 'process raft request' (duration: 83.993644ms)","trace[1534853275] 'compare' (duration: 29.224541ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:41.889113Z","caller":"traceutil/trace.go:171","msg":"trace[1161967222] transaction","detail":"{read_only:false; response_revision:880; number_of_response:1; }","duration":"137.469348ms","start":"2026-05-27T05:59:41.75161Z","end":"2026-05-27T05:59:41.889079Z","steps":["trace[1161967222] 'process raft request' (duration: 137.408966ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:41.889356Z","caller":"traceutil/trace.go:171","msg":"trace[324901332] transaction","detail":"{read_only:false; response_revision:876; number_of_response:1; }","duration":"139.030675ms","start":"2026-05-27T05:59:41.750304Z","end":"2026-05-27T05:59:41.889335Z","steps":["trace[324901332] 'process raft request' (duration: 138.40806ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:41.889479Z","caller":"traceutil/trace.go:171","msg":"trace[57371489] transaction","detail":"{read_only:false; response_revision:878; number_of_response:1; }","duration":"139.032625ms","start":"2026-05-27T05:59:41.750436Z","end":"2026-05-27T05:59:41.889469Z","steps":["trace[57371489] 'process raft request' (duration: 138.506152ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:41.889816Z","caller":"traceutil/trace.go:171","msg":"trace[1397220349] transaction","detail":"{read_only:false; response_revision:879; number_of_response:1; }","duration":"139.280041ms","start":"2026-05-27T05:59:41.750496Z","end":"2026-05-27T05:59:41.889776Z","steps":["trace[1397220349] 'process raft request' (duration: 138.486162ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:41.889987Z","caller":"traceutil/trace.go:171","msg":"trace[168005432] transaction","detail":"{read_only:false; response_revision:877; number_of_response:1; }","duration":"139.606088ms","start":"2026-05-27T05:59:41.750362Z","end":"2026-05-27T05:59:41.889968Z","steps":["trace[168005432] 'process raft request' (duration: 138.531573ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.491691Z","caller":"traceutil/trace.go:171","msg":"trace[512370198] linearizableReadLoop","detail":"{readStateIndex:928; appliedIndex:927; }","duration":"239.532392ms","start":"2026-05-27T05:59:43.252133Z","end":"2026-05-27T05:59:43.491666Z","steps":["trace[512370198] 'read index received' (duration: 239.492921ms)","trace[512370198] 'applied index is now lower than readState.Index' (duration: 37.981µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:43.491731Z","caller":"traceutil/trace.go:171","msg":"trace[1670832501] transaction","detail":"{read_only:false; response_revision:893; number_of_response:1; }","duration":"255.70986ms","start":"2026-05-27T05:59:43.23597Z","end":"2026-05-27T05:59:43.49168Z","steps":["trace[1670832501] 'process raft request' (duration: 255.555717ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:43.492056Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"239.89608ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/coredns-67659f764b-8gsl6\" ","response":"range_response_count:1 size:4776"} {"level":"info","ts":"2026-05-27T05:59:43.49216Z","caller":"traceutil/trace.go:171","msg":"trace[1255562999] range","detail":"{range_begin:/registry/pods/kube-system/coredns-67659f764b-8gsl6; range_end:; response_count:1; response_revision:893; }","duration":"240.059614ms","start":"2026-05-27T05:59:43.252076Z","end":"2026-05-27T05:59:43.492135Z","steps":["trace[1255562999] 'agreement among raft nodes before linearized reading' (duration: 239.705936ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.521822Z","caller":"traceutil/trace.go:171","msg":"trace[546728965] transaction","detail":"{read_only:false; response_revision:894; number_of_response:1; }","duration":"142.903714ms","start":"2026-05-27T05:59:43.37889Z","end":"2026-05-27T05:59:43.521794Z","steps":["trace[546728965] 'process raft request' (duration: 142.73304ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:43.521947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.747494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:490"} {"level":"info","ts":"2026-05-27T05:59:43.522049Z","caller":"traceutil/trace.go:171","msg":"trace[500357350] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:894; }","duration":"244.834036ms","start":"2026-05-27T05:59:43.27716Z","end":"2026-05-27T05:59:43.521994Z","steps":["trace[500357350] 'agreement among raft nodes before linearized reading' (duration: 244.686062ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:43.521868Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"261.438856ms","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-27T05:59:43.522132Z","caller":"traceutil/trace.go:171","msg":"trace[708673930] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:894; }","duration":"261.773794ms","start":"2026-05-27T05:59:43.260347Z","end":"2026-05-27T05:59:43.522121Z","steps":["trace[708673930] 'agreement among raft nodes before linearized reading' (duration: 261.397895ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.664045Z","caller":"traceutil/trace.go:171","msg":"trace[697055941] transaction","detail":"{read_only:false; response_revision:895; number_of_response:1; }","duration":"168.32528ms","start":"2026-05-27T05:59:43.495704Z","end":"2026-05-27T05:59:43.664029Z","steps":["trace[697055941] 'process raft request' (duration: 148.210958ms)","trace[697055941] 'compare' (duration: 19.869767ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:43.664042Z","caller":"traceutil/trace.go:171","msg":"trace[1730429791] transaction","detail":"{read_only:false; response_revision:896; number_of_response:1; }","duration":"161.844097ms","start":"2026-05-27T05:59:43.502174Z","end":"2026-05-27T05:59:43.664018Z","steps":["trace[1730429791] 'process raft request' (duration: 161.754145ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.716561Z","caller":"traceutil/trace.go:171","msg":"trace[397522836] transaction","detail":"{read_only:false; response_revision:897; number_of_response:1; }","duration":"190.50367ms","start":"2026-05-27T05:59:43.526019Z","end":"2026-05-27T05:59:43.716522Z","steps":["trace[397522836] 'process raft request' (duration: 190.260715ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.716578Z","caller":"traceutil/trace.go:171","msg":"trace[433322964] transaction","detail":"{read_only:false; response_revision:898; number_of_response:1; }","duration":"190.238035ms","start":"2026-05-27T05:59:43.526307Z","end":"2026-05-27T05:59:43.716545Z","steps":["trace[433322964] 'process raft request' (duration: 190.147173ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:43.856501Z","caller":"traceutil/trace.go:171","msg":"trace[2021889757] transaction","detail":"{read_only:false; response_revision:905; number_of_response:1; }","duration":"102.105765ms","start":"2026-05-27T05:59:43.754367Z","end":"2026-05-27T05:59:43.856473Z","steps":["trace[2021889757] 'process raft request' (duration: 101.600174ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:45.861152Z","caller":"traceutil/trace.go:171","msg":"trace[1850847250] transaction","detail":"{read_only:false; response_revision:930; number_of_response:1; }","duration":"136.199625ms","start":"2026-05-27T05:59:45.724918Z","end":"2026-05-27T05:59:45.861117Z","steps":["trace[1850847250] 'process raft request' (duration: 135.99736ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:45.957686Z","caller":"traceutil/trace.go:171","msg":"trace[1857833159] linearizableReadLoop","detail":"{readStateIndex:966; appliedIndex:964; }","duration":"189.860475ms","start":"2026-05-27T05:59:45.767796Z","end":"2026-05-27T05:59:45.957657Z","steps":["trace[1857833159] 'read index received' (duration: 93.183062ms)","trace[1857833159] 'applied index is now lower than readState.Index' (duration: 96.676243ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:45.957828Z","caller":"traceutil/trace.go:171","msg":"trace[1328667512] transaction","detail":"{read_only:false; response_revision:931; number_of_response:1; }","duration":"231.540516ms","start":"2026-05-27T05:59:45.726274Z","end":"2026-05-27T05:59:45.957815Z","steps":["trace[1328667512] 'process raft request' (duration: 206.930212ms)","trace[1328667512] 'compare' (duration: 24.310327ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:45.958266Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.454889ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:45.958321Z","caller":"traceutil/trace.go:171","msg":"trace[1204731174] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:931; }","duration":"190.543811ms","start":"2026-05-27T05:59:45.767759Z","end":"2026-05-27T05:59:45.958302Z","steps":["trace[1204731174] 'agreement among raft nodes before linearized reading' (duration: 190.451738ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:46.605293Z","caller":"traceutil/trace.go:171","msg":"trace[1348215315] transaction","detail":"{read_only:false; response_revision:941; number_of_response:1; }","duration":"306.200194ms","start":"2026-05-27T05:59:46.299058Z","end":"2026-05-27T05:59:46.605258Z","steps":["trace[1348215315] 'process raft request' (duration: 293.51507ms)","trace[1348215315] 'compare' (duration: 12.52868ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:46.605476Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:46.299045Z","time spent":"306.336228ms","remote":"127.0.0.1:52602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1109,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-27T05:59:46.832465Z","caller":"traceutil/trace.go:171","msg":"trace[560162120] linearizableReadLoop","detail":"{readStateIndex:979; appliedIndex:978; }","duration":"133.373679ms","start":"2026-05-27T05:59:46.699055Z","end":"2026-05-27T05:59:46.832428Z","steps":["trace[560162120] 'read index received' (duration: 51.772623ms)","trace[560162120] 'applied index is now lower than readState.Index' (duration: 81.599956ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:46.832525Z","caller":"traceutil/trace.go:171","msg":"trace[156025217] transaction","detail":"{read_only:false; response_revision:943; number_of_response:1; }","duration":"148.991302ms","start":"2026-05-27T05:59:46.683485Z","end":"2026-05-27T05:59:46.832476Z","steps":["trace[156025217] 'process raft request' (duration: 67.329374ms)","trace[156025217] 'compare' (duration: 81.476294ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:46.832723Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.632835ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-27T05:59:46.83279Z","caller":"traceutil/trace.go:171","msg":"trace[411837294] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:943; }","duration":"133.750839ms","start":"2026-05-27T05:59:46.699024Z","end":"2026-05-27T05:59:46.832775Z","steps":["trace[411837294] 'agreement among raft nodes before linearized reading' (duration: 133.558213ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:46.978611Z","caller":"traceutil/trace.go:171","msg":"trace[1054795567] transaction","detail":"{read_only:false; response_revision:944; number_of_response:1; }","duration":"141.392396ms","start":"2026-05-27T05:59:46.837189Z","end":"2026-05-27T05:59:46.978581Z","steps":["trace[1054795567] 'process raft request' (duration: 131.23068ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.157702Z","caller":"traceutil/trace.go:171","msg":"trace[107545355] transaction","detail":"{read_only:false; response_revision:946; number_of_response:1; }","duration":"170.459759ms","start":"2026-05-27T05:59:46.987214Z","end":"2026-05-27T05:59:47.157674Z","steps":["trace[107545355] 'process raft request' (duration: 170.029259ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.297664Z","caller":"traceutil/trace.go:171","msg":"trace[1685497260] transaction","detail":"{read_only:false; response_revision:948; number_of_response:1; }","duration":"226.606518ms","start":"2026-05-27T05:59:47.071033Z","end":"2026-05-27T05:59:47.297639Z","steps":["trace[1685497260] 'process raft request' (duration: 226.529396ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.297703Z","caller":"traceutil/trace.go:171","msg":"trace[39204709] transaction","detail":"{read_only:false; response_revision:947; number_of_response:1; }","duration":"227.917859ms","start":"2026-05-27T05:59:47.069725Z","end":"2026-05-27T05:59:47.297643Z","steps":["trace[39204709] 'process raft request' (duration: 226.502177ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.357399Z","caller":"traceutil/trace.go:171","msg":"trace[695310775] linearizableReadLoop","detail":"{readStateIndex:985; appliedIndex:982; }","duration":"145.632313ms","start":"2026-05-27T05:59:47.211737Z","end":"2026-05-27T05:59:47.35737Z","steps":["trace[695310775] 'read index received' (duration: 84.505827ms)","trace[695310775] 'applied index is now lower than readState.Index' (duration: 61.125246ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:47.35744Z","caller":"traceutil/trace.go:171","msg":"trace[755699987] transaction","detail":"{read_only:false; response_revision:949; number_of_response:1; }","duration":"196.683105ms","start":"2026-05-27T05:59:47.160735Z","end":"2026-05-27T05:59:47.357418Z","steps":["trace[755699987] 'process raft request' (duration: 196.545382ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:47.357785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.015902ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/local-path-storage/\" range_end:\"/registry/secrets/local-path-storage0\" ","response":"range_response_count:1 size:12755"} {"level":"info","ts":"2026-05-27T05:59:47.357901Z","caller":"traceutil/trace.go:171","msg":"trace[1385540534] range","detail":"{range_begin:/registry/secrets/local-path-storage/; range_end:/registry/secrets/local-path-storage0; response_count:1; response_revision:949; }","duration":"146.192995ms","start":"2026-05-27T05:59:47.211682Z","end":"2026-05-27T05:59:47.357875Z","steps":["trace[1385540534] 'agreement among raft nodes before linearized reading' (duration: 145.785426ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.618455Z","caller":"traceutil/trace.go:171","msg":"trace[564287010] linearizableReadLoop","detail":"{readStateIndex:990; appliedIndex:989; }","duration":"208.744085ms","start":"2026-05-27T05:59:47.409689Z","end":"2026-05-27T05:59:47.618433Z","steps":["trace[564287010] 'read index received' (duration: 173.640262ms)","trace[564287010] 'applied index is now lower than readState.Index' (duration: 35.102823ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:47.618519Z","caller":"traceutil/trace.go:171","msg":"trace[1469349640] transaction","detail":"{read_only:false; response_revision:954; number_of_response:1; }","duration":"208.901679ms","start":"2026-05-27T05:59:47.409574Z","end":"2026-05-27T05:59:47.618476Z","steps":["trace[1469349640] 'process raft request' (duration: 173.707064ms)","trace[1469349640] 'compare' (duration: 35.020151ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:47.618709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.999911ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/local-path-provisioner-679c578f5-xbfqx\" ","response":"range_response_count:1 size:2650"} {"level":"info","ts":"2026-05-27T05:59:47.618754Z","caller":"traceutil/trace.go:171","msg":"trace[1919467163] range","detail":"{range_begin:/registry/pods/local-path-storage/local-path-provisioner-679c578f5-xbfqx; range_end:; response_count:1; response_revision:954; }","duration":"209.095803ms","start":"2026-05-27T05:59:47.409645Z","end":"2026-05-27T05:59:47.61874Z","steps":["trace[1919467163] 'agreement among raft nodes before linearized reading' (duration: 208.904929ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:47.648838Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.823379ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/replicasets/local-path-storage/local-path-provisioner-679c578f5\" ","response":"range_response_count:1 size:3219"} {"level":"info","ts":"2026-05-27T05:59:47.64896Z","caller":"traceutil/trace.go:171","msg":"trace[1401001095] transaction","detail":"{read_only:false; response_revision:955; number_of_response:1; }","duration":"103.114878ms","start":"2026-05-27T05:59:47.545818Z","end":"2026-05-27T05:59:47.648933Z","steps":["trace[1401001095] 'process raft request' (duration: 102.709109ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:47.649096Z","caller":"traceutil/trace.go:171","msg":"trace[633306813] range","detail":"{range_begin:/registry/replicasets/local-path-storage/local-path-provisioner-679c578f5; range_end:; response_count:1; response_revision:955; }","duration":"238.026363ms","start":"2026-05-27T05:59:47.410967Z","end":"2026-05-27T05:59:47.648993Z","steps":["trace[633306813] 'agreement among raft nodes before linearized reading' (duration: 237.702176ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:47.649333Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.310321ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/local-path-storage/\" range_end:\"/registry/secrets/local-path-storage0\" ","response":"range_response_count:1 size:12755"} {"level":"info","ts":"2026-05-27T05:59:47.649386Z","caller":"traceutil/trace.go:171","msg":"trace[1774463256] range","detail":"{range_begin:/registry/secrets/local-path-storage/; range_end:/registry/secrets/local-path-storage0; response_count:1; response_revision:955; }","duration":"235.380662ms","start":"2026-05-27T05:59:47.413992Z","end":"2026-05-27T05:59:47.649373Z","steps":["trace[1774463256] 'agreement among raft nodes before linearized reading' (duration: 235.149077ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.068565Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.566478ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-27T05:59:48.068849Z","caller":"traceutil/trace.go:171","msg":"trace[979342256] transaction","detail":"{read_only:false; response_revision:956; number_of_response:1; }","duration":"443.693123ms","start":"2026-05-27T05:59:47.625076Z","end":"2026-05-27T05:59:48.068769Z","steps":["trace[979342256] 'process raft request' (duration: 341.815087ms)","trace[979342256] 'compare' (duration: 101.254591ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:48.069024Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.625049Z","time spent":"443.902128ms","remote":"127.0.0.1:52422","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3595,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T05:59:48.287773Z","caller":"traceutil/trace.go:171","msg":"trace[536044903] linearizableReadLoop","detail":"{readStateIndex:993; appliedIndex:991; }","duration":"601.436279ms","start":"2026-05-27T05:59:47.686304Z","end":"2026-05-27T05:59:48.28774Z","steps":["trace[536044903] 'read index received' (duration: 280.600448ms)","trace[536044903] 'applied index is now lower than readState.Index' (duration: 320.834491ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:48.287924Z","caller":"traceutil/trace.go:171","msg":"trace[32744593] transaction","detail":"{read_only:false; response_revision:957; number_of_response:1; }","duration":"632.867688ms","start":"2026-05-27T05:59:47.655044Z","end":"2026-05-27T05:59:48.287912Z","steps":["trace[32744593] 'process raft request' (duration: 561.624764ms)","trace[32744593] 'compare' (duration: 70.898716ms)"],"step_count":2} {"level":"warn","ts":"2026-05-27T05:59:48.288065Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.655017Z","time spent":"632.951099ms","remote":"127.0.0.1:52724","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3249,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:48.288054Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"519.640526ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:48.288152Z","caller":"traceutil/trace.go:171","msg":"trace[2089655451] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:957; }","duration":"519.794979ms","start":"2026-05-27T05:59:47.768331Z","end":"2026-05-27T05:59:48.288126Z","steps":["trace[2089655451] 'agreement among raft nodes before linearized reading' (duration: 519.624475ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.288203Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.768308Z","time spent":"519.885331ms","remote":"127.0.0.1:52250","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-05-27T05:59:48.288213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.090759ms","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-27T05:59:48.288256Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.487945ms","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-05-27T05:59:48.28832Z","caller":"traceutil/trace.go:171","msg":"trace[52120822] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:957; }","duration":"281.218812ms","start":"2026-05-27T05:59:48.007078Z","end":"2026-05-27T05:59:48.288297Z","steps":["trace[52120822] 'agreement among raft nodes before linearized reading' (duration: 280.894115ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:48.288363Z","caller":"traceutil/trace.go:171","msg":"trace[1514734254] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:957; }","duration":"241.634909ms","start":"2026-05-27T05:59:48.046703Z","end":"2026-05-27T05:59:48.288338Z","steps":["trace[1514734254] 'agreement among raft nodes before linearized reading' (duration: 241.370683ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.288364Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"423.229001ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-27T05:59:48.288436Z","caller":"traceutil/trace.go:171","msg":"trace[1399782635] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:957; }","duration":"423.335695ms","start":"2026-05-27T05:59:47.865078Z","end":"2026-05-27T05:59:48.288414Z","steps":["trace[1399782635] 'agreement among raft nodes before linearized reading' (duration: 423.15291ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.288485Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.865048Z","time spent":"423.427866ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-05-27T05:59:48.288552Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"322.672933ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"warn","ts":"2026-05-27T05:59:48.288618Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.970526ms","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-27T05:59:48.28869Z","caller":"traceutil/trace.go:171","msg":"trace[2106103970] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:957; }","duration":"242.082849ms","start":"2026-05-27T05:59:48.046594Z","end":"2026-05-27T05:59:48.288677Z","steps":["trace[2106103970] 'agreement among raft nodes before linearized reading' (duration: 241.897584ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.28816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"395.034679ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:48.288866Z","caller":"traceutil/trace.go:171","msg":"trace[1532483283] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:957; }","duration":"395.791396ms","start":"2026-05-27T05:59:47.893064Z","end":"2026-05-27T05:59:48.288855Z","steps":["trace[1532483283] 'agreement among raft nodes before linearized reading' (duration: 395.002718ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.28858Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"602.270279ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/local-path-storage/local-path-provisioner\" ","response":"range_response_count:1 size:897"} {"level":"info","ts":"2026-05-27T05:59:48.288945Z","caller":"traceutil/trace.go:171","msg":"trace[1501998860] range","detail":"{range_begin:/registry/serviceaccounts/local-path-storage/local-path-provisioner; range_end:; response_count:1; response_revision:957; }","duration":"602.663817ms","start":"2026-05-27T05:59:47.686267Z","end":"2026-05-27T05:59:48.288931Z","steps":["trace[1501998860] 'agreement among raft nodes before linearized reading' (duration: 602.241898ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.288994Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.686246Z","time spent":"602.73347ms","remote":"127.0.0.1:52450","response type":"/etcdserverpb.KV/Range","request count":0,"request size":69,"response count":1,"response size":921,"request content":"key:\"/registry/serviceaccounts/local-path-storage/local-path-provisioner\" "} {"level":"warn","ts":"2026-05-27T05:59:48.288904Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.893053Z","time spent":"395.838677ms","remote":"127.0.0.1:52362","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":0,"response size":29,"request content":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true "} {"level":"info","ts":"2026-05-27T05:59:48.288651Z","caller":"traceutil/trace.go:171","msg":"trace[960692688] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:957; }","duration":"322.856027ms","start":"2026-05-27T05:59:47.965778Z","end":"2026-05-27T05:59:48.288634Z","steps":["trace[960692688] 'agreement among raft nodes before linearized reading' (duration: 322.436517ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:48.289907Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:47.965744Z","time spent":"324.143907ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-05-27T05:59:48.455985Z","caller":"traceutil/trace.go:171","msg":"trace[1373006451] transaction","detail":"{read_only:false; response_revision:959; number_of_response:1; }","duration":"163.123586ms","start":"2026-05-27T05:59:48.292825Z","end":"2026-05-27T05:59:48.455949Z","steps":["trace[1373006451] 'process raft request' (duration: 118.651169ms)","trace[1373006451] 'compare' (duration: 44.251932ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:48.45623Z","caller":"traceutil/trace.go:171","msg":"trace[1329068992] transaction","detail":"{read_only:false; response_revision:960; number_of_response:1; }","duration":"163.200807ms","start":"2026-05-27T05:59:48.292989Z","end":"2026-05-27T05:59:48.45619Z","steps":["trace[1329068992] 'process raft request' (duration: 162.913231ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:48.456351Z","caller":"traceutil/trace.go:171","msg":"trace[2122312031] transaction","detail":"{read_only:false; response_revision:963; number_of_response:1; }","duration":"161.591891ms","start":"2026-05-27T05:59:48.294745Z","end":"2026-05-27T05:59:48.456337Z","steps":["trace[2122312031] 'process raft request' (duration: 161.5438ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:48.456378Z","caller":"traceutil/trace.go:171","msg":"trace[1147273241] transaction","detail":"{read_only:false; response_revision:961; number_of_response:1; }","duration":"162.999823ms","start":"2026-05-27T05:59:48.293297Z","end":"2026-05-27T05:59:48.456297Z","steps":["trace[1147273241] 'process raft request' (duration: 162.841049ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:48.456424Z","caller":"traceutil/trace.go:171","msg":"trace[2140983714] transaction","detail":"{read_only:false; response_revision:962; number_of_response:1; }","duration":"162.355049ms","start":"2026-05-27T05:59:48.294025Z","end":"2026-05-27T05:59:48.45638Z","steps":["trace[2140983714] 'process raft request' (duration: 162.172865ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:50.410403Z","caller":"traceutil/trace.go:171","msg":"trace[743751793] transaction","detail":"{read_only:false; response_revision:976; number_of_response:1; }","duration":"121.722012ms","start":"2026-05-27T05:59:50.288649Z","end":"2026-05-27T05:59:50.410371Z","steps":["trace[743751793] 'process raft request' (duration: 120.930303ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:56.877904Z","caller":"traceutil/trace.go:171","msg":"trace[566693442] linearizableReadLoop","detail":"{readStateIndex:1043; appliedIndex:1042; }","duration":"237.62435ms","start":"2026-05-27T05:59:56.640252Z","end":"2026-05-27T05:59:56.877877Z","steps":["trace[566693442] 'read index received' (duration: 237.470596ms)","trace[566693442] 'applied index is now lower than readState.Index' (duration: 152.874µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T05:59:56.877961Z","caller":"traceutil/trace.go:171","msg":"trace[433983377] transaction","detail":"{read_only:false; response_revision:1005; number_of_response:1; }","duration":"369.622621ms","start":"2026-05-27T05:59:56.508288Z","end":"2026-05-27T05:59:56.877911Z","steps":["trace[433983377] 'process raft request' (duration: 369.424087ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:56.878184Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T05:59:56.508269Z","time spent":"369.799075ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-27T05:59:56.878253Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.412035ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-05-27T05:59:56.87826Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.009979ms","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-27T05:59:56.878308Z","caller":"traceutil/trace.go:171","msg":"trace[861705173] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1005; }","duration":"233.512187ms","start":"2026-05-27T05:59:56.644788Z","end":"2026-05-27T05:59:56.8783Z","steps":["trace[861705173] 'agreement among raft nodes before linearized reading' (duration: 233.432965ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:56.87836Z","caller":"traceutil/trace.go:171","msg":"trace[487873242] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1005; }","duration":"238.130411ms","start":"2026-05-27T05:59:56.64018Z","end":"2026-05-27T05:59:56.87831Z","steps":["trace[487873242] 'agreement among raft nodes before linearized reading' (duration: 237.835945ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:56.878206Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.223872ms","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-27T05:59:56.878402Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"214.873516ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-27T05:59:56.878486Z","caller":"traceutil/trace.go:171","msg":"trace[653992957] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1005; }","duration":"234.517049ms","start":"2026-05-27T05:59:56.643914Z","end":"2026-05-27T05:59:56.878431Z","steps":["trace[653992957] 'agreement among raft nodes before linearized reading' (duration: 234.12376ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T05:59:56.878535Z","caller":"traceutil/trace.go:171","msg":"trace[211258064] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1005; }","duration":"215.012201ms","start":"2026-05-27T05:59:56.663466Z","end":"2026-05-27T05:59:56.878479Z","steps":["trace[211258064] 'agreement among raft nodes before linearized reading' (duration: 214.648922ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T05:59:56.878775Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.321116ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T05:59:56.878876Z","caller":"traceutil/trace.go:171","msg":"trace[353275950] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1005; }","duration":"111.444099ms","start":"2026-05-27T05:59:56.767418Z","end":"2026-05-27T05:59:56.878862Z","steps":["trace[353275950] 'agreement among raft nodes before linearized reading' (duration: 111.317917ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:05.867993Z","caller":"traceutil/trace.go:171","msg":"trace[2080375210] transaction","detail":"{read_only:false; response_revision:1036; number_of_response:1; }","duration":"117.850991ms","start":"2026-05-27T06:00:05.750107Z","end":"2026-05-27T06:00:05.867958Z","steps":["trace[2080375210] 'process raft request' (duration: 117.633316ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:05.951943Z","caller":"traceutil/trace.go:171","msg":"trace[1144202223] transaction","detail":"{read_only:false; response_revision:1037; number_of_response:1; }","duration":"151.352875ms","start":"2026-05-27T06:00:05.800561Z","end":"2026-05-27T06:00:05.951914Z","steps":["trace[1144202223] 'process raft request' (duration: 127.625146ms)","trace[1144202223] 'compare' (duration: 23.606617ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T06:00:07.145364Z","caller":"traceutil/trace.go:171","msg":"trace[743311529] linearizableReadLoop","detail":"{readStateIndex:1079; appliedIndex:1078; }","duration":"203.973785ms","start":"2026-05-27T06:00:06.941366Z","end":"2026-05-27T06:00:07.14534Z","steps":["trace[743311529] 'read index received' (duration: 203.820382ms)","trace[743311529] 'applied index is now lower than readState.Index' (duration: 149.093µs)"],"step_count":2} {"level":"info","ts":"2026-05-27T06:00:07.145403Z","caller":"traceutil/trace.go:171","msg":"trace[1139049105] transaction","detail":"{read_only:false; response_revision:1039; number_of_response:1; }","duration":"210.348535ms","start":"2026-05-27T06:00:06.935031Z","end":"2026-05-27T06:00:07.145379Z","steps":["trace[1139049105] 'process raft request' (duration: 210.13125ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:07.145706Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.988192ms","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-27T06:00:07.145689Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.294822ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-27T06:00:07.145746Z","caller":"traceutil/trace.go:171","msg":"trace[181864873] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1039; }","duration":"196.080013ms","start":"2026-05-27T06:00:06.949656Z","end":"2026-05-27T06:00:07.145736Z","steps":["trace[181864873] 'agreement among raft nodes before linearized reading' (duration: 195.857909ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:07.14578Z","caller":"traceutil/trace.go:171","msg":"trace[620389913] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1039; }","duration":"204.451006ms","start":"2026-05-27T06:00:06.94131Z","end":"2026-05-27T06:00:07.145761Z","steps":["trace[620389913] 'agreement among raft nodes before linearized reading' (duration: 204.153959ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:07.145942Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.664674ms","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-27T06:00:07.145972Z","caller":"traceutil/trace.go:171","msg":"trace[1506620624] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1039; }","duration":"189.717694ms","start":"2026-05-27T06:00:06.956247Z","end":"2026-05-27T06:00:07.145965Z","steps":["trace[1506620624] 'agreement among raft nodes before linearized reading' (duration: 189.643553ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:07.145989Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.259145ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-27T06:00:07.146082Z","caller":"traceutil/trace.go:171","msg":"trace[98327432] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1039; }","duration":"189.381407ms","start":"2026-05-27T06:00:06.956678Z","end":"2026-05-27T06:00:07.146059Z","steps":["trace[98327432] 'agreement among raft nodes before linearized reading' (duration: 189.152102ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:15.336702Z","caller":"traceutil/trace.go:171","msg":"trace[1640809604] transaction","detail":"{read_only:false; response_revision:1070; number_of_response:1; }","duration":"115.169271ms","start":"2026-05-27T06:00:15.221487Z","end":"2026-05-27T06:00:15.336656Z","steps":["trace[1640809604] 'process raft request' (duration: 110.708417ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:19.686002Z","caller":"traceutil/trace.go:171","msg":"trace[826788013] transaction","detail":"{read_only:false; response_revision:1084; number_of_response:1; }","duration":"230.790707ms","start":"2026-05-27T06:00:19.455183Z","end":"2026-05-27T06:00:19.685974Z","steps":["trace[826788013] 'process raft request' (duration: 131.070208ms)","trace[826788013] 'compare' (duration: 99.591676ms)"],"step_count":2} {"level":"info","ts":"2026-05-27T06:00:19.686786Z","caller":"traceutil/trace.go:171","msg":"trace[822508556] transaction","detail":"{read_only:false; response_revision:1086; number_of_response:1; }","duration":"229.585731ms","start":"2026-05-27T06:00:19.45718Z","end":"2026-05-27T06:00:19.686766Z","steps":["trace[822508556] 'process raft request' (duration: 229.440718ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:19.686777Z","caller":"traceutil/trace.go:171","msg":"trace[301090376] transaction","detail":"{read_only:false; response_revision:1085; number_of_response:1; }","duration":"231.238536ms","start":"2026-05-27T06:00:19.45551Z","end":"2026-05-27T06:00:19.686749Z","steps":["trace[301090376] 'process raft request' (duration: 231.011381ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:21.928059Z","caller":"traceutil/trace.go:171","msg":"trace[320827331] transaction","detail":"{read_only:false; response_revision:1091; number_of_response:1; }","duration":"233.116568ms","start":"2026-05-27T06:00:21.694919Z","end":"2026-05-27T06:00:21.928035Z","steps":["trace[320827331] 'process raft request' (duration: 232.985965ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:22.050571Z","caller":"traceutil/trace.go:171","msg":"trace[854709807] transaction","detail":"{read_only:false; response_revision:1092; number_of_response:1; }","duration":"355.333414ms","start":"2026-05-27T06:00:21.695222Z","end":"2026-05-27T06:00:22.050555Z","steps":["trace[854709807] 'process raft request' (duration: 349.749047ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:22.051345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T06:00:21.695204Z","time spent":"355.419856ms","remote":"127.0.0.1:52504","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-27T06:00:22.051846Z","caller":"traceutil/trace.go:171","msg":"trace[1798007509] transaction","detail":"{read_only:false; response_revision:1093; number_of_response:1; }","duration":"356.603651ms","start":"2026-05-27T06:00:21.695228Z","end":"2026-05-27T06:00:22.051832Z","steps":["trace[1798007509] 'process raft request' (duration: 355.304833ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:22.051894Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-27T06:00:21.695209Z","time spent":"356.663582ms","remote":"127.0.0.1:52504","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-05-27T06:00:23.652751Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.319129ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-27T06:00:23.652801Z","caller":"traceutil/trace.go:171","msg":"trace[288492723] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:1096; }","duration":"127.400621ms","start":"2026-05-27T06:00:23.525388Z","end":"2026-05-27T06:00:23.652789Z","steps":["trace[288492723] 'count revisions from in-memory index tree' (duration: 127.262658ms)"],"step_count":1} {"level":"warn","ts":"2026-05-27T06:00:23.652749Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"188.800059ms","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-27T06:00:23.653012Z","caller":"traceutil/trace.go:171","msg":"trace[456808578] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1096; }","duration":"189.121626ms","start":"2026-05-27T06:00:23.463886Z","end":"2026-05-27T06:00:23.653007Z","steps":["trace[456808578] 'range keys from in-memory index tree' (duration: 188.649846ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:00:24.170154Z","caller":"traceutil/trace.go:171","msg":"trace[1571368706] transaction","detail":"{read_only:false; response_revision:1101; number_of_response:1; }","duration":"106.834997ms","start":"2026-05-27T06:00:24.063293Z","end":"2026-05-27T06:00:24.170128Z","steps":["trace[1571368706] 'process raft request' (duration: 106.678024ms)"],"step_count":1} {"level":"info","ts":"2026-05-27T06:01:28.117221Z","caller":"traceutil/trace.go:171","msg":"trace[848176923] transaction","detail":"{read_only:false; response_revision:1339; number_of_response:1; }","duration":"156.020071ms","start":"2026-05-27T06:01:27.961177Z","end":"2026-05-27T06:01:28.117197Z","steps":["trace[848176923] 'process raft request' (duration: 155.879998ms)"],"step_count":1}