{"level":"warn","ts":"2026-07-09T23:49:16.653967Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-09T23:49:16.654047Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.157: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.157:2380","--initial-cluster=instance=https://199.204.45.157:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.157:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.157: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-07-09T23:49:16.654111Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-09T23:49:16.654123Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.157:2380"]} {"level":"info","ts":"2026-07-09T23:49:16.654138Z","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-07-09T23:49:16.656112Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.157:2379"]} {"level":"info","ts":"2026-07-09T23:49:16.656208Z","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.157:2380"],"listen-peer-urls":["https://199.204.45.157:2380"],"advertise-client-urls":["https://199.204.45.157:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.157:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.157: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-07-09T23:49:16.65909Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"2.676934ms"} {"level":"info","ts":"2026-07-09T23:49:16.664446Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"5f170c75a1d97cc","cluster-id":"44a3176ec85feb9"} {"level":"info","ts":"2026-07-09T23:49:16.664512Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc switched to configuration voters=()"} {"level":"info","ts":"2026-07-09T23:49:16.664615Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc became follower at term 0"} {"level":"info","ts":"2026-07-09T23:49:16.664633Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 5f170c75a1d97cc [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-09T23:49:16.664649Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc became follower at term 1"} {"level":"info","ts":"2026-07-09T23:49:16.664689Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc switched to configuration voters=(428247441089599436)"} {"level":"warn","ts":"2026-07-09T23:49:16.669584Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-09T23:49:16.67119Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-09T23:49:16.672535Z","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-07-09T23:49:16.675252Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"5f170c75a1d97cc","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-09T23:49:16.675903Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"5f170c75a1d97cc","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-09T23:49:16.676068Z","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-07-09T23:49:16.676119Z","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-07-09T23:49:16.676133Z","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-07-09T23:49:16.676922Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc switched to configuration voters=(428247441089599436)"} {"level":"info","ts":"2026-07-09T23:49:16.678Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"44a3176ec85feb9","local-member-id":"5f170c75a1d97cc","added-peer-id":"5f170c75a1d97cc","added-peer-peer-urls":["https://199.204.45.157:2380"]} {"level":"info","ts":"2026-07-09T23:49:16.680964Z","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-07-09T23:49:16.681151Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"5f170c75a1d97cc","initial-advertise-peer-urls":["https://199.204.45.157:2380"],"listen-peer-urls":["https://199.204.45.157:2380"],"advertise-client-urls":["https://199.204.45.157:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.157:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-09T23:49:16.681181Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-09T23:49:16.681282Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.157:2380"} {"level":"info","ts":"2026-07-09T23:49:16.681298Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.157:2380"} {"level":"info","ts":"2026-07-09T23:49:17.265658Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc is starting a new election at term 1"} {"level":"info","ts":"2026-07-09T23:49:17.265698Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc became pre-candidate at term 1"} {"level":"info","ts":"2026-07-09T23:49:17.265721Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc received MsgPreVoteResp from 5f170c75a1d97cc at term 1"} {"level":"info","ts":"2026-07-09T23:49:17.265733Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc became candidate at term 2"} {"level":"info","ts":"2026-07-09T23:49:17.265738Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc received MsgVoteResp from 5f170c75a1d97cc at term 2"} {"level":"info","ts":"2026-07-09T23:49:17.265746Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5f170c75a1d97cc became leader at term 2"} {"level":"info","ts":"2026-07-09T23:49:17.265752Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 5f170c75a1d97cc elected leader 5f170c75a1d97cc at term 2"} {"level":"info","ts":"2026-07-09T23:49:17.266831Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-09T23:49:17.267628Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-09T23:49:17.26762Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"5f170c75a1d97cc","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.157:2379]}","request-path":"/0/members/5f170c75a1d97cc/attributes","cluster-id":"44a3176ec85feb9","publish-timeout":"7s"} {"level":"info","ts":"2026-07-09T23:49:17.267658Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-09T23:49:17.269396Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"44a3176ec85feb9","local-member-id":"5f170c75a1d97cc","cluster-version":"3.5"} {"level":"info","ts":"2026-07-09T23:49:17.269502Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-09T23:49:17.269523Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-09T23:49:17.270811Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.157:2379"} {"level":"info","ts":"2026-07-09T23:49:17.271271Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-09T23:49:17.273759Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-09T23:49:17.273812Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-09T23:49:22.070164Z","caller":"traceutil/trace.go:171","msg":"trace[1825594535] transaction","detail":"{read_only:false; response_revision:225; number_of_response:1; }","duration":"501.809886ms","start":"2026-07-09T23:49:21.568312Z","end":"2026-07-09T23:49:22.070121Z","steps":["trace[1825594535] 'process raft request' (duration: 501.621601ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:49:22.070281Z","caller":"traceutil/trace.go:171","msg":"trace[1808153027] transaction","detail":"{read_only:false; response_revision:224; number_of_response:1; }","duration":"501.939229ms","start":"2026-07-09T23:49:21.56831Z","end":"2026-07-09T23:49:22.070249Z","steps":["trace[1808153027] 'process raft request' (duration: 501.484217ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:22.070752Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:21.568291Z","time spent":"501.95916ms","remote":"127.0.0.1:41076","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4003,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-09T23:49:22.070955Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:21.56829Z","time spent":"502.056283ms","remote":"127.0.0.1:41114","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":192,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-09T23:49:22.259546Z","caller":"traceutil/trace.go:171","msg":"trace[1723958484] linearizableReadLoop","detail":"{readStateIndex:233; appliedIndex:232; }","duration":"166.997868ms","start":"2026-07-09T23:49:22.092526Z","end":"2026-07-09T23:49:22.259524Z","steps":["trace[1723958484] 'read index received' (duration: 166.857544ms)","trace[1723958484] 'applied index is now lower than readState.Index' (duration: 139.164µs)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:49:22.259669Z","caller":"traceutil/trace.go:171","msg":"trace[205049377] transaction","detail":"{read_only:false; response_revision:227; number_of_response:1; }","duration":"167.230944ms","start":"2026-07-09T23:49:22.092428Z","end":"2026-07-09T23:49:22.259659Z","steps":["trace[205049377] 'process raft request' (duration: 166.979967ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:22.259817Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.073291ms","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-07-09T23:49:22.259964Z","caller":"traceutil/trace.go:171","msg":"trace[1497105173] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:227; }","duration":"167.273565ms","start":"2026-07-09T23:49:22.092668Z","end":"2026-07-09T23:49:22.259941Z","steps":["trace[1497105173] 'agreement among raft nodes before linearized reading' (duration: 167.003588ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:22.260165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.609065ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-07-09T23:49:22.26025Z","caller":"traceutil/trace.go:171","msg":"trace[1300787830] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:227; }","duration":"167.741509ms","start":"2026-07-09T23:49:22.092489Z","end":"2026-07-09T23:49:22.26023Z","steps":["trace[1300787830] 'agreement among raft nodes before linearized reading' (duration: 167.564763ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:49:54.566992Z","caller":"traceutil/trace.go:171","msg":"trace[758687491] linearizableReadLoop","detail":"{readStateIndex:581; appliedIndex:580; }","duration":"369.129086ms","start":"2026-07-09T23:49:54.197842Z","end":"2026-07-09T23:49:54.566972Z","steps":["trace[758687491] 'read index received' (duration: 366.190181ms)","trace[758687491] 'applied index is now lower than readState.Index' (duration: 2.937945ms)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:49:54.567021Z","caller":"traceutil/trace.go:171","msg":"trace[1141398665] transaction","detail":"{read_only:false; response_revision:559; number_of_response:1; }","duration":"377.8948ms","start":"2026-07-09T23:49:54.189094Z","end":"2026-07-09T23:49:54.566989Z","steps":["trace[1141398665] 'process raft request' (duration: 374.998776ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:54.567195Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:54.189078Z","time spent":"378.032743ms","remote":"127.0.0.1:40956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":208461,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-09T23:49:54.567239Z","caller":"traceutil/trace.go:171","msg":"trace[682140247] transaction","detail":"{read_only:false; response_revision:560; number_of_response:1; }","duration":"341.101916ms","start":"2026-07-09T23:49:54.226094Z","end":"2026-07-09T23:49:54.567196Z","steps":["trace[682140247] 'process raft request' (duration: 340.837167ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:54.567313Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.856126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-07-09T23:49:54.567365Z","caller":"traceutil/trace.go:171","msg":"trace[417488850] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:560; }","duration":"153.958028ms","start":"2026-07-09T23:49:54.413393Z","end":"2026-07-09T23:49:54.567351Z","steps":["trace[417488850] 'agreement among raft nodes before linearized reading' (duration: 153.782593ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:54.56739Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:54.226057Z","time spent":"341.252351ms","remote":"127.0.0.1:40956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":15673,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-09T23:49:54.567828Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.57448ms","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-07-09T23:49:54.567879Z","caller":"traceutil/trace.go:171","msg":"trace[1312090525] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:560; }","duration":"151.672303ms","start":"2026-07-09T23:49:54.416193Z","end":"2026-07-09T23:49:54.567866Z","steps":["trace[1312090525] 'agreement among raft nodes before linearized reading' (duration: 151.121597ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:54.569445Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"371.571716ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/gatewayclasses.gateway.networking.k8s.io\" ","response":"range_response_count:1 size:10870"} {"level":"info","ts":"2026-07-09T23:49:54.569527Z","caller":"traceutil/trace.go:171","msg":"trace[669816750] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/gatewayclasses.gateway.networking.k8s.io; range_end:; response_count:1; response_revision:560; }","duration":"371.68871ms","start":"2026-07-09T23:49:54.197819Z","end":"2026-07-09T23:49:54.569508Z","steps":["trace[669816750] 'agreement among raft nodes before linearized reading' (duration: 369.24693ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:54.569581Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:54.197809Z","time spent":"371.762832ms","remote":"127.0.0.1:40956","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":1,"response size":10892,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/gatewayclasses.gateway.networking.k8s.io\" "} {"level":"info","ts":"2026-07-09T23:49:58.726174Z","caller":"traceutil/trace.go:171","msg":"trace[1300898826] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"108.101824ms","start":"2026-07-09T23:49:58.618046Z","end":"2026-07-09T23:49:58.726148Z","steps":["trace[1300898826] 'process raft request' (duration: 107.955139ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:49:58.738125Z","caller":"traceutil/trace.go:171","msg":"trace[668014653] transaction","detail":"{read_only:false; response_revision:586; number_of_response:1; }","duration":"118.687579ms","start":"2026-07-09T23:49:58.619416Z","end":"2026-07-09T23:49:58.738103Z","steps":["trace[668014653] 'process raft request' (duration: 118.601886ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:59.172194Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"332.161708ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-zqcrh\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-07-09T23:49:59.172519Z","caller":"traceutil/trace.go:171","msg":"trace[930789726] range","detail":"{range_begin:/registry/pods/kube-system/cilium-zqcrh; range_end:; response_count:1; response_revision:586; }","duration":"332.514897ms","start":"2026-07-09T23:49:58.839973Z","end":"2026-07-09T23:49:59.172488Z","steps":["trace[930789726] 'range keys from in-memory index tree' (duration: 331.942991ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:59.172598Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:58.839954Z","time spent":"332.630202ms","remote":"127.0.0.1:41092","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16987,"request content":"key:\"/registry/pods/kube-system/cilium-zqcrh\" "} {"level":"info","ts":"2026-07-09T23:49:59.405296Z","caller":"traceutil/trace.go:171","msg":"trace[1300485642] linearizableReadLoop","detail":"{readStateIndex:610; appliedIndex:609; }","duration":"311.860591ms","start":"2026-07-09T23:49:59.09341Z","end":"2026-07-09T23:49:59.40527Z","steps":["trace[1300485642] 'read index received' (duration: 311.257323ms)","trace[1300485642] 'applied index is now lower than readState.Index' (duration: 602.298µs)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:49:59.405337Z","caller":"traceutil/trace.go:171","msg":"trace[655661809] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"516.459003ms","start":"2026-07-09T23:49:58.888859Z","end":"2026-07-09T23:49:59.405318Z","steps":["trace[655661809] 'process raft request' (duration: 515.864526ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:59.40546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:58.888832Z","time spent":"516.552846ms","remote":"127.0.0.1:40994","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036253,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-09T23:49:59.405485Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"312.064897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-07-09T23:49:59.405522Z","caller":"traceutil/trace.go:171","msg":"trace[266876674] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:587; }","duration":"312.138458ms","start":"2026-07-09T23:49:59.093373Z","end":"2026-07-09T23:49:59.405511Z","steps":["trace[266876674] 'agreement among raft nodes before linearized reading' (duration: 312.012615ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:59.405562Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:49:59.093357Z","time spent":"312.196941ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":527,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"info","ts":"2026-07-09T23:49:59.411272Z","caller":"traceutil/trace.go:171","msg":"trace[856240469] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"222.18788ms","start":"2026-07-09T23:49:59.189025Z","end":"2026-07-09T23:49:59.411213Z","steps":["trace[856240469] 'process raft request' (duration: 221.643275ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:49:59.41144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.933578ms","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-07-09T23:49:59.411524Z","caller":"traceutil/trace.go:171","msg":"trace[1665978301] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:588; }","duration":"272.106423ms","start":"2026-07-09T23:49:59.139397Z","end":"2026-07-09T23:49:59.411503Z","steps":["trace[1665978301] 'agreement among raft nodes before linearized reading' (duration: 271.548006ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:50:47.107211Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.62351ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-07-09T23:50:47.107323Z","caller":"traceutil/trace.go:171","msg":"trace[2050575226] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:962; }","duration":"152.778083ms","start":"2026-07-09T23:50:46.954521Z","end":"2026-07-09T23:50:47.107299Z","steps":["trace[2050575226] 'range keys from in-memory index tree' (duration: 152.458914ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:50:47.107467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.223817ms","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-07-09T23:50:47.107562Z","caller":"traceutil/trace.go:171","msg":"trace[1019392446] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:962; }","duration":"153.33609ms","start":"2026-07-09T23:50:46.954202Z","end":"2026-07-09T23:50:47.107539Z","steps":["trace[1019392446] 'range keys from in-memory index tree' (duration: 153.029431ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:07.986755Z","caller":"traceutil/trace.go:171","msg":"trace[1546251286] linearizableReadLoop","detail":"{readStateIndex:1070; appliedIndex:1069; }","duration":"189.514615ms","start":"2026-07-09T23:51:07.797215Z","end":"2026-07-09T23:51:07.98673Z","steps":["trace[1546251286] 'read index received' (duration: 189.335471ms)","trace[1546251286] 'applied index is now lower than readState.Index' (duration: 177.994µs)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:07.986896Z","caller":"traceutil/trace.go:171","msg":"trace[1334701198] transaction","detail":"{read_only:false; response_revision:1031; number_of_response:1; }","duration":"191.747297ms","start":"2026-07-09T23:51:07.795111Z","end":"2026-07-09T23:51:07.986858Z","steps":["trace[1334701198] 'process raft request' (duration: 191.4886ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:07.986977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.746982ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-09T23:51:07.987014Z","caller":"traceutil/trace.go:171","msg":"trace[1553432596] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1031; }","duration":"189.839355ms","start":"2026-07-09T23:51:07.797163Z","end":"2026-07-09T23:51:07.987002Z","steps":["trace[1553432596] 'agreement among raft nodes before linearized reading' (duration: 189.65881ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:08.631136Z","caller":"traceutil/trace.go:171","msg":"trace[947981406] transaction","detail":"{read_only:false; response_revision:1033; number_of_response:1; }","duration":"122.465722ms","start":"2026-07-09T23:51:08.50865Z","end":"2026-07-09T23:51:08.631116Z","steps":["trace[947981406] 'process raft request' (duration: 122.147353ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:09.342742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.849321ms","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-07-09T23:51:09.342862Z","caller":"traceutil/trace.go:171","msg":"trace[2019703517] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1034; }","duration":"137.005096ms","start":"2026-07-09T23:51:09.20584Z","end":"2026-07-09T23:51:09.342845Z","steps":["trace[2019703517] 'range keys from in-memory index tree' (duration: 136.709809ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:09.342865Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.82977ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-09T23:51:09.342982Z","caller":"traceutil/trace.go:171","msg":"trace[705626070] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1034; }","duration":"132.950724ms","start":"2026-07-09T23:51:09.210012Z","end":"2026-07-09T23:51:09.342962Z","steps":["trace[705626070] 'range keys from in-memory index tree' (duration: 132.819589ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:09.34298Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.076286ms","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-07-09T23:51:09.343059Z","caller":"traceutil/trace.go:171","msg":"trace[945897538] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1034; }","duration":"138.210709ms","start":"2026-07-09T23:51:09.204829Z","end":"2026-07-09T23:51:09.34304Z","steps":["trace[945897538] 'range keys from in-memory index tree' (duration: 137.88452ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:09.453791Z","caller":"traceutil/trace.go:171","msg":"trace[1558203304] transaction","detail":"{read_only:false; response_revision:1035; number_of_response:1; }","duration":"106.716625ms","start":"2026-07-09T23:51:09.347029Z","end":"2026-07-09T23:51:09.453745Z","steps":["trace[1558203304] 'process raft request' (duration: 106.426678ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:09.460992Z","caller":"traceutil/trace.go:171","msg":"trace[1448687941] transaction","detail":"{read_only:false; response_revision:1036; number_of_response:1; }","duration":"113.885084ms","start":"2026-07-09T23:51:09.347072Z","end":"2026-07-09T23:51:09.460957Z","steps":["trace[1448687941] 'process raft request' (duration: 113.691198ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:10.440899Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.905794ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-09T23:51:10.440997Z","caller":"traceutil/trace.go:171","msg":"trace[1868504171] linearizableReadLoop","detail":"{readStateIndex:1077; appliedIndex:1076; }","duration":"335.312145ms","start":"2026-07-09T23:51:10.105668Z","end":"2026-07-09T23:51:10.44098Z","steps":["trace[1868504171] 'read index received' (duration: 229.996639ms)","trace[1868504171] 'applied index is now lower than readState.Index' (duration: 105.314326ms)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:10.4412Z","caller":"traceutil/trace.go:171","msg":"trace[1278358035] transaction","detail":"{read_only:false; response_revision:1038; number_of_response:1; }","duration":"352.754539ms","start":"2026-07-09T23:51:10.088431Z","end":"2026-07-09T23:51:10.441186Z","steps":["trace[1278358035] 'process raft request' (duration: 247.29015ms)","trace[1278358035] 'compare' (duration: 104.745809ms)"],"step_count":2} {"level":"warn","ts":"2026-07-09T23:51:10.441269Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:10.088416Z","time spent":"352.819182ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-09T23:51:10.441377Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"335.690015ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-09T23:51:10.441479Z","caller":"traceutil/trace.go:171","msg":"trace[1043533696] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:1038; }","duration":"335.83963ms","start":"2026-07-09T23:51:10.105619Z","end":"2026-07-09T23:51:10.441458Z","steps":["trace[1043533696] 'agreement among raft nodes before linearized reading' (duration: 335.660895ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:10.441528Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:10.10557Z","time spent":"335.946903ms","remote":"127.0.0.1:44084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":130,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-07-09T23:51:10.441723Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"317.368316ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.157\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-07-09T23:51:10.441875Z","caller":"traceutil/trace.go:171","msg":"trace[93859936] range","detail":"{range_begin:/registry/masterleases/199.204.45.157; range_end:; response_count:1; response_revision:1038; }","duration":"317.576412ms","start":"2026-07-09T23:51:10.124257Z","end":"2026-07-09T23:51:10.441834Z","steps":["trace[93859936] 'agreement among raft nodes before linearized reading' (duration: 317.075488ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:10.441976Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:10.124241Z","time spent":"317.722217ms","remote":"127.0.0.1:40948","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.157\" "} {"level":"warn","ts":"2026-07-09T23:51:25.964719Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"381.684474ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"warn","ts":"2026-07-09T23:51:25.964801Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.715657ms","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-07-09T23:51:25.964832Z","caller":"traceutil/trace.go:171","msg":"trace[1732992184] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1138; }","duration":"381.830859ms","start":"2026-07-09T23:51:25.582985Z","end":"2026-07-09T23:51:25.964815Z","steps":["trace[1732992184] 'range keys from in-memory index tree' (duration: 381.56307ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:25.964872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:25.582971Z","time spent":"381.892929ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-07-09T23:51:25.964851Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"409.653021ms","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-07-09T23:51:25.964889Z","caller":"traceutil/trace.go:171","msg":"trace[1724368031] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:1138; }","duration":"321.83513ms","start":"2026-07-09T23:51:25.643022Z","end":"2026-07-09T23:51:25.964857Z","steps":["trace[1724368031] 'count revisions from in-memory index tree' (duration: 321.631734ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:25.964932Z","caller":"traceutil/trace.go:171","msg":"trace[290919848] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1138; }","duration":"409.777904ms","start":"2026-07-09T23:51:25.555135Z","end":"2026-07-09T23:51:25.964913Z","steps":["trace[290919848] 'range keys from in-memory index tree' (duration: 409.490476ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:25.964934Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:25.642984Z","time spent":"321.939255ms","remote":"127.0.0.1:41018","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":0,"response size":27,"request content":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true "} {"level":"warn","ts":"2026-07-09T23:51:25.964972Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:25.555115Z","time spent":"409.849086ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-07-09T23:51:25.964977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.209003ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-09T23:51:25.965109Z","caller":"traceutil/trace.go:171","msg":"trace[646324962] transaction","detail":"{read_only:false; response_revision:1139; number_of_response:1; }","duration":"278.277271ms","start":"2026-07-09T23:51:25.686817Z","end":"2026-07-09T23:51:25.965094Z","steps":["trace[646324962] 'process raft request' (duration: 109.860452ms)","trace[646324962] 'compare' (duration: 168.080999ms)"],"step_count":2} {"level":"warn","ts":"2026-07-09T23:51:44.272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.534589ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-09T23:51:44.272266Z","caller":"traceutil/trace.go:171","msg":"trace[981319824] transaction","detail":"{read_only:false; response_revision:1235; number_of_response:1; }","duration":"226.593164ms","start":"2026-07-09T23:51:44.045645Z","end":"2026-07-09T23:51:44.272238Z","steps":["trace[981319824] 'process raft request' (duration: 15.728626ms)","trace[981319824] 'compare' (duration: 210.346544ms)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:44.272581Z","caller":"traceutil/trace.go:171","msg":"trace[1300907449] transaction","detail":"{read_only:false; response_revision:1236; number_of_response:1; }","duration":"226.385348ms","start":"2026-07-09T23:51:44.046184Z","end":"2026-07-09T23:51:44.272569Z","steps":["trace[1300907449] 'process raft request' (duration: 225.919136ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:44.272934Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.0423ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-09T23:51:44.273038Z","caller":"traceutil/trace.go:171","msg":"trace[823070696] range","detail":"{range_begin:/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1236; }","duration":"168.188054ms","start":"2026-07-09T23:51:44.104827Z","end":"2026-07-09T23:51:44.273015Z","steps":["trace[823070696] 'agreement among raft nodes before linearized reading' (duration: 167.955577ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:44.273488Z","caller":"traceutil/trace.go:171","msg":"trace[931791908] linearizableReadLoop","detail":"{readStateIndex:1284; appliedIndex:1282; }","duration":"167.462835ms","start":"2026-07-09T23:51:44.104868Z","end":"2026-07-09T23:51:44.272331Z","steps":["trace[931791908] 'read index received' (duration: 31.821µs)","trace[931791908] 'applied index is now lower than readState.Index' (duration: 167.430104ms)"],"step_count":2} {"level":"warn","ts":"2026-07-09T23:51:44.782299Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.594358ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-09T23:51:44.782426Z","caller":"traceutil/trace.go:171","msg":"trace[1885040832] transaction","detail":"{read_only:false; response_revision:1237; number_of_response:1; }","duration":"505.366615ms","start":"2026-07-09T23:51:44.277031Z","end":"2026-07-09T23:51:44.782397Z","steps":["trace[1885040832] 'process raft request' (duration: 209.610623ms)","trace[1885040832] 'compare' (duration: 295.351511ms)"],"step_count":2} {"level":"warn","ts":"2026-07-09T23:51:44.782517Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:44.277012Z","time spent":"505.48272ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":518,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-09T23:51:44.788639Z","caller":"traceutil/trace.go:171","msg":"trace[1300021079] linearizableReadLoop","detail":"{readStateIndex:1287; appliedIndex:1285; }","duration":"200.716147ms","start":"2026-07-09T23:51:44.587884Z","end":"2026-07-09T23:51:44.7886Z","steps":["trace[1300021079] 'read index received' (duration: 200.397988ms)","trace[1300021079] 'applied index is now lower than readState.Index' (duration: 316.949µs)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:44.789048Z","caller":"traceutil/trace.go:171","msg":"trace[802912183] transaction","detail":"{read_only:false; response_revision:1238; number_of_response:1; }","duration":"510.401116ms","start":"2026-07-09T23:51:44.27863Z","end":"2026-07-09T23:51:44.789032Z","steps":["trace[802912183] 'process raft request' (duration: 509.743008ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:44.789195Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:44.278614Z","time spent":"510.472168ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-09T23:51:44.789409Z","caller":"traceutil/trace.go:171","msg":"trace[930751860] transaction","detail":"{read_only:false; response_revision:1239; number_of_response:1; }","duration":"426.901581ms","start":"2026-07-09T23:51:44.362495Z","end":"2026-07-09T23:51:44.789396Z","steps":["trace[930751860] 'process raft request' (duration: 426.053047ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:44.789463Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:44.362465Z","time spent":"426.967952ms","remote":"127.0.0.1:40986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":788,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-09T23:51:44.789802Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.897189ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-09T23:51:44.789884Z","caller":"traceutil/trace.go:171","msg":"trace[101512994] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1239; }","duration":"202.032573ms","start":"2026-07-09T23:51:44.587821Z","end":"2026-07-09T23:51:44.789853Z","steps":["trace[101512994] 'agreement among raft nodes before linearized reading' (duration: 201.819877ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:44.939451Z","caller":"traceutil/trace.go:171","msg":"trace[43269876] transaction","detail":"{read_only:false; response_revision:1240; number_of_response:1; }","duration":"144.98633ms","start":"2026-07-09T23:51:44.794434Z","end":"2026-07-09T23:51:44.939421Z","steps":["trace[43269876] 'process raft request' (duration: 109.383653ms)","trace[43269876] 'compare' (duration: 35.467194ms)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:44.992682Z","caller":"traceutil/trace.go:171","msg":"trace[905437615] transaction","detail":"{read_only:false; response_revision:1242; number_of_response:1; }","duration":"197.58243ms","start":"2026-07-09T23:51:44.795073Z","end":"2026-07-09T23:51:44.992656Z","steps":["trace[905437615] 'process raft request' (duration: 197.481698ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:44.992689Z","caller":"traceutil/trace.go:171","msg":"trace[1317882377] transaction","detail":"{read_only:false; response_revision:1241; number_of_response:1; }","duration":"197.836246ms","start":"2026-07-09T23:51:44.794807Z","end":"2026-07-09T23:51:44.992644Z","steps":["trace[1317882377] 'process raft request' (duration: 197.623881ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:44.992998Z","caller":"traceutil/trace.go:171","msg":"trace[1821926733] transaction","detail":"{read_only:false; response_revision:1243; number_of_response:1; }","duration":"197.559039ms","start":"2026-07-09T23:51:44.795419Z","end":"2026-07-09T23:51:44.992978Z","steps":["trace[1821926733] 'process raft request' (duration: 197.182658ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:44.993039Z","caller":"traceutil/trace.go:171","msg":"trace[123888180] transaction","detail":"{read_only:false; response_revision:1244; number_of_response:1; }","duration":"166.531188ms","start":"2026-07-09T23:51:44.826482Z","end":"2026-07-09T23:51:44.993014Z","steps":["trace[123888180] 'process raft request' (duration: 166.379994ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:45.448453Z","caller":"traceutil/trace.go:171","msg":"trace[109937447] transaction","detail":"{read_only:false; response_revision:1245; number_of_response:1; }","duration":"101.017151ms","start":"2026-07-09T23:51:45.347409Z","end":"2026-07-09T23:51:45.448426Z","steps":["trace[109937447] 'process raft request' (duration: 100.862237ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:54.610335Z","caller":"traceutil/trace.go:171","msg":"trace[526074504] transaction","detail":"{read_only:false; response_revision:1301; number_of_response:1; }","duration":"295.060333ms","start":"2026-07-09T23:51:54.315253Z","end":"2026-07-09T23:51:54.610313Z","steps":["trace[526074504] 'process raft request' (duration: 294.945ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:54.996187Z","caller":"traceutil/trace.go:171","msg":"trace[1529070741] linearizableReadLoop","detail":"{readStateIndex:1352; appliedIndex:1351; }","duration":"244.683317ms","start":"2026-07-09T23:51:54.751482Z","end":"2026-07-09T23:51:54.996165Z","steps":["trace[1529070741] 'read index received' (duration: 243.800993ms)","trace[1529070741] 'applied index is now lower than readState.Index' (duration: 881.284µs)"],"step_count":2} {"level":"info","ts":"2026-07-09T23:51:54.996204Z","caller":"traceutil/trace.go:171","msg":"trace[1249582928] transaction","detail":"{read_only:false; response_revision:1302; number_of_response:1; }","duration":"679.419783ms","start":"2026-07-09T23:51:54.316763Z","end":"2026-07-09T23:51:54.996183Z","steps":["trace[1249582928] 'process raft request' (duration: 678.541039ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:54.996384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.887103ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-09T23:51:54.996496Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-09T23:51:54.316747Z","time spent":"679.65616ms","remote":"127.0.0.1:41186","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-09T23:51:54.996524Z","caller":"traceutil/trace.go:171","msg":"trace[539188118] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1302; }","duration":"245.078987ms","start":"2026-07-09T23:51:54.751422Z","end":"2026-07-09T23:51:54.996501Z","steps":["trace[539188118] 'agreement among raft nodes before linearized reading' (duration: 244.840061ms)"],"step_count":1} {"level":"warn","ts":"2026-07-09T23:51:54.996748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.222594ms","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-07-09T23:51:54.996815Z","caller":"traceutil/trace.go:171","msg":"trace[79597620] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1302; }","duration":"169.310176ms","start":"2026-07-09T23:51:54.82749Z","end":"2026-07-09T23:51:54.9968Z","steps":["trace[79597620] 'agreement among raft nodes before linearized reading' (duration: 169.163132ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:55.109715Z","caller":"traceutil/trace.go:171","msg":"trace[268372564] transaction","detail":"{read_only:false; response_revision:1304; number_of_response:1; }","duration":"108.481258ms","start":"2026-07-09T23:51:55.001205Z","end":"2026-07-09T23:51:55.109686Z","steps":["trace[268372564] 'process raft request' (duration: 108.067417ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:55.109743Z","caller":"traceutil/trace.go:171","msg":"trace[298318525] transaction","detail":"{read_only:false; response_revision:1305; number_of_response:1; }","duration":"108.295434ms","start":"2026-07-09T23:51:55.001426Z","end":"2026-07-09T23:51:55.109721Z","steps":["trace[298318525] 'process raft request' (duration: 107.884933ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:51:55.109787Z","caller":"traceutil/trace.go:171","msg":"trace[2031900747] transaction","detail":"{read_only:false; response_revision:1303; number_of_response:1; }","duration":"109.686323ms","start":"2026-07-09T23:51:55.000077Z","end":"2026-07-09T23:51:55.109763Z","steps":["trace[2031900747] 'process raft request' (duration: 107.548803ms)"],"step_count":1} {"level":"info","ts":"2026-07-09T23:56:08.97566Z","caller":"traceutil/trace.go:171","msg":"trace[561822374] transaction","detail":"{read_only:false; response_revision:2497; number_of_response:1; }","duration":"119.150304ms","start":"2026-07-09T23:56:08.856467Z","end":"2026-07-09T23:56:08.975617Z","steps":["trace[561822374] 'process raft request' (duration: 118.935888ms)"],"step_count":1}