{"level":"warn","ts":"2026-05-14T09:33:00.451727Z","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-14T09:33:00.451806Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.70: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.70:2380","--initial-cluster=instance=https://199.204.45.70:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.70:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.70: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-14T09:33:00.451868Z","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-14T09:33:00.451879Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.70:2380"]} {"level":"info","ts":"2026-05-14T09:33:00.451895Z","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-14T09:33:00.452619Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"]} {"level":"info","ts":"2026-05-14T09:33:00.452705Z","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.70:2380"],"listen-peer-urls":["https://199.204.45.70:2380"],"advertise-client-urls":["https://199.204.45.70:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.70: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-14T09:33:00.456142Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.242354ms"} {"level":"info","ts":"2026-05-14T09:33:00.461133Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"f8844a9a4263041d","cluster-id":"4749b7c221ae0648"} {"level":"info","ts":"2026-05-14T09:33:00.46175Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=()"} {"level":"info","ts":"2026-05-14T09:33:00.461782Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became follower at term 0"} {"level":"info","ts":"2026-05-14T09:33:00.461843Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft f8844a9a4263041d [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-14T09:33:00.46188Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became follower at term 1"} {"level":"info","ts":"2026-05-14T09:33:00.461936Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=(17907520044731139101)"} {"level":"warn","ts":"2026-05-14T09:33:00.466969Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-14T09:33:00.468058Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-14T09:33:00.469151Z","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-14T09:33:00.470921Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"f8844a9a4263041d","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-14T09:33:00.471016Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"f8844a9a4263041d","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-14T09:33:00.472324Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d switched to configuration voters=(17907520044731139101)"} {"level":"info","ts":"2026-05-14T09:33:00.471328Z","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-14T09:33:00.473023Z","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-14T09:33:00.473057Z","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-14T09:33:00.473354Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"4749b7c221ae0648","local-member-id":"f8844a9a4263041d","added-peer-id":"f8844a9a4263041d","added-peer-peer-urls":["https://199.204.45.70:2380"]} {"level":"info","ts":"2026-05-14T09:33:00.483914Z","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-14T09:33:00.484306Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"f8844a9a4263041d","initial-advertise-peer-urls":["https://199.204.45.70:2380"],"listen-peer-urls":["https://199.204.45.70:2380"],"advertise-client-urls":["https://199.204.45.70:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.70:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-14T09:33:00.484376Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-14T09:33:00.484667Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.70:2380"} {"level":"info","ts":"2026-05-14T09:33:00.484702Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.70:2380"} {"level":"info","ts":"2026-05-14T09:33:00.662261Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d is starting a new election at term 1"} {"level":"info","ts":"2026-05-14T09:33:00.662335Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became pre-candidate at term 1"} {"level":"info","ts":"2026-05-14T09:33:00.662361Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d received MsgPreVoteResp from f8844a9a4263041d at term 1"} {"level":"info","ts":"2026-05-14T09:33:00.662384Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became candidate at term 2"} {"level":"info","ts":"2026-05-14T09:33:00.662418Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d received MsgVoteResp from f8844a9a4263041d at term 2"} {"level":"info","ts":"2026-05-14T09:33:00.662454Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f8844a9a4263041d became leader at term 2"} {"level":"info","ts":"2026-05-14T09:33:00.66249Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: f8844a9a4263041d elected leader f8844a9a4263041d at term 2"} {"level":"info","ts":"2026-05-14T09:33:00.663452Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"f8844a9a4263041d","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.70:2379]}","request-path":"/0/members/f8844a9a4263041d/attributes","cluster-id":"4749b7c221ae0648","publish-timeout":"7s"} {"level":"info","ts":"2026-05-14T09:33:00.663503Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-14T09:33:00.663961Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-14T09:33:00.664091Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-14T09:33:00.664217Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-14T09:33:00.664261Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-14T09:33:00.666002Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-14T09:33:00.666452Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"4749b7c221ae0648","local-member-id":"f8844a9a4263041d","cluster-version":"3.5"} {"level":"info","ts":"2026-05-14T09:33:00.667357Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-14T09:33:00.667448Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-14T09:33:00.667778Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.70:2379"} {"level":"info","ts":"2026-05-14T09:33:29.776256Z","caller":"traceutil/trace.go:171","msg":"trace[987527040] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"107.796365ms","start":"2026-05-14T09:33:29.667481Z","end":"2026-05-14T09:33:29.775277Z","steps":["trace[987527040] 'process raft request' (duration: 102.57635ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:33:29.779073Z","caller":"traceutil/trace.go:171","msg":"trace[1789171336] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"102.56663ms","start":"2026-05-14T09:33:29.676468Z","end":"2026-05-14T09:33:29.779035Z","steps":["trace[1789171336] 'process raft request' (duration: 99.993008ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:33:36.076119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.450242ms","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-14T09:33:36.076278Z","caller":"traceutil/trace.go:171","msg":"trace[397053794] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:619; }","duration":"142.711607ms","start":"2026-05-14T09:33:35.933543Z","end":"2026-05-14T09:33:36.076254Z","steps":["trace[397053794] 'range keys from in-memory index tree' (duration: 142.279239ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:33:36.548001Z","caller":"traceutil/trace.go:171","msg":"trace[1477036735] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"428.939077ms","start":"2026-05-14T09:33:36.11904Z","end":"2026-05-14T09:33:36.547979Z","steps":["trace[1477036735] 'process raft request' (duration: 408.674639ms)","trace[1477036735] 'compare' (duration: 20.163236ms)"],"step_count":2} {"level":"warn","ts":"2026-05-14T09:33:36.550003Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:33:36.119015Z","time spent":"429.10656ms","remote":"127.0.0.1:45350","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4538,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-14T09:33:36.626024Z","caller":"traceutil/trace.go:171","msg":"trace[64576291] linearizableReadLoop","detail":"{readStateIndex:647; appliedIndex:644; }","duration":"128.707275ms","start":"2026-05-14T09:33:36.497291Z","end":"2026-05-14T09:33:36.625998Z","steps":["trace[64576291] 'read index received' (duration: 30.612595ms)","trace[64576291] 'applied index is now lower than readState.Index' (duration: 98.09357ms)"],"step_count":2} {"level":"info","ts":"2026-05-14T09:33:36.626102Z","caller":"traceutil/trace.go:171","msg":"trace[316646437] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"499.067667ms","start":"2026-05-14T09:33:36.126945Z","end":"2026-05-14T09:33:36.626012Z","steps":["trace[316646437] 'process raft request' (duration: 498.876652ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:33:36.626342Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:33:36.126926Z","time spent":"499.335772ms","remote":"127.0.0.1:45464","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-14T09:33:36.626312Z","caller":"traceutil/trace.go:171","msg":"trace[497186823] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"491.664237ms","start":"2026-05-14T09:33:36.134628Z","end":"2026-05-14T09:33:36.626292Z","steps":["trace[497186823] 'process raft request' (duration: 491.30687ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:33:36.62658Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.272397ms","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-05-14T09:33:36.626945Z","caller":"traceutil/trace.go:171","msg":"trace[2005365554] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:624; }","duration":"129.686075ms","start":"2026-05-14T09:33:36.497234Z","end":"2026-05-14T09:33:36.62692Z","steps":["trace[2005365554] 'agreement among raft nodes before linearized reading' (duration: 129.150544ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:33:36.627047Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:33:36.13461Z","time spent":"492.385832ms","remote":"127.0.0.1:45430","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-14T09:33:37.989663Z","caller":"traceutil/trace.go:171","msg":"trace[1916470110] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"114.383948ms","start":"2026-05-14T09:33:37.87525Z","end":"2026-05-14T09:33:37.989634Z","steps":["trace[1916470110] 'process raft request' (duration: 113.49127ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:34:25.030222Z","caller":"traceutil/trace.go:171","msg":"trace[1435746419] transaction","detail":"{read_only:false; response_revision:998; number_of_response:1; }","duration":"119.223499ms","start":"2026-05-14T09:34:24.910922Z","end":"2026-05-14T09:34:25.030146Z","steps":["trace[1435746419] 'process raft request' (duration: 118.916713ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:01.418964Z","caller":"traceutil/trace.go:171","msg":"trace[878166940] transaction","detail":"{read_only:false; response_revision:1167; number_of_response:1; }","duration":"189.816549ms","start":"2026-05-14T09:35:01.229121Z","end":"2026-05-14T09:35:01.418937Z","steps":["trace[878166940] 'process raft request' (duration: 189.682247ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:01.759796Z","caller":"traceutil/trace.go:171","msg":"trace[2017671341] linearizableReadLoop","detail":"{readStateIndex:1212; appliedIndex:1210; }","duration":"515.606635ms","start":"2026-05-14T09:35:01.244161Z","end":"2026-05-14T09:35:01.759767Z","steps":["trace[2017671341] 'read index received' (duration: 174.668042ms)","trace[2017671341] 'applied index is now lower than readState.Index' (duration: 340.937433ms)"],"step_count":2} {"level":"warn","ts":"2026-05-14T09:35:01.760264Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.433837ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-14T09:35:01.760278Z","caller":"traceutil/trace.go:171","msg":"trace[908853810] transaction","detail":"{read_only:false; response_revision:1168; number_of_response:1; }","duration":"527.423176ms","start":"2026-05-14T09:35:01.232823Z","end":"2026-05-14T09:35:01.760246Z","steps":["trace[908853810] 'process raft request' (duration: 460.10252ms)","trace[908853810] 'compare' (duration: 66.548151ms)"],"step_count":2} {"level":"info","ts":"2026-05-14T09:35:01.760315Z","caller":"traceutil/trace.go:171","msg":"trace[1639658317] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1168; }","duration":"287.531289ms","start":"2026-05-14T09:35:01.472769Z","end":"2026-05-14T09:35:01.760301Z","steps":["trace[1639658317] 'agreement among raft nodes before linearized reading' (duration: 287.440407ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:01.76043Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:35:01.232798Z","time spent":"527.547718ms","remote":"127.0.0.1:45464","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-14T09:35:01.760553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"499.939809ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-05-14T09:35:01.760593Z","caller":"traceutil/trace.go:171","msg":"trace[1965764407] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1168; }","duration":"500.01413ms","start":"2026-05-14T09:35:01.260568Z","end":"2026-05-14T09:35:01.760582Z","steps":["trace[1965764407] 'agreement among raft nodes before linearized reading' (duration: 499.435529ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:01.760622Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:35:01.26055Z","time spent":"500.064152ms","remote":"127.0.0.1:45464","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-05-14T09:35:01.760936Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"516.767387ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-05-14T09:35:01.760973Z","caller":"traceutil/trace.go:171","msg":"trace[1798433898] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1168; }","duration":"516.837829ms","start":"2026-05-14T09:35:01.244126Z","end":"2026-05-14T09:35:01.760963Z","steps":["trace[1798433898] 'agreement among raft nodes before linearized reading' (duration: 515.929691ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:01.761113Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:35:01.244113Z","time spent":"516.986951ms","remote":"127.0.0.1:45464","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-05-14T09:35:18.669814Z","caller":"traceutil/trace.go:171","msg":"trace[1661240894] linearizableReadLoop","detail":"{readStateIndex:1291; appliedIndex:1290; }","duration":"107.396158ms","start":"2026-05-14T09:35:18.562394Z","end":"2026-05-14T09:35:18.66979Z","steps":["trace[1661240894] 'read index received' (duration: 107.197434ms)","trace[1661240894] 'applied index is now lower than readState.Index' (duration: 197.814µs)"],"step_count":2} {"level":"info","ts":"2026-05-14T09:35:18.67016Z","caller":"traceutil/trace.go:171","msg":"trace[1640470286] transaction","detail":"{read_only:false; response_revision:1244; number_of_response:1; }","duration":"116.251282ms","start":"2026-05-14T09:35:18.553879Z","end":"2026-05-14T09:35:18.67013Z","steps":["trace[1640470286] 'process raft request' (duration: 115.775782ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:18.670324Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.213246ms","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-14T09:35:18.67039Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.964159ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-05-14T09:35:18.670413Z","caller":"traceutil/trace.go:171","msg":"trace[1699916062] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1244; }","duration":"105.328138ms","start":"2026-05-14T09:35:18.565064Z","end":"2026-05-14T09:35:18.670392Z","steps":["trace[1699916062] 'agreement among raft nodes before linearized reading' (duration: 105.043342ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:18.670494Z","caller":"traceutil/trace.go:171","msg":"trace[330613272] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1244; }","duration":"108.082502ms","start":"2026-05-14T09:35:18.56237Z","end":"2026-05-14T09:35:18.670452Z","steps":["trace[330613272] 'agreement among raft nodes before linearized reading' (duration: 107.804996ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:18.800259Z","caller":"traceutil/trace.go:171","msg":"trace[1474522277] transaction","detail":"{read_only:false; response_revision:1245; number_of_response:1; }","duration":"125.341409ms","start":"2026-05-14T09:35:18.674869Z","end":"2026-05-14T09:35:18.80021Z","steps":["trace[1474522277] 'process raft request' (duration: 99.34673ms)","trace[1474522277] 'compare' (duration: 25.489498ms)"],"step_count":2} {"level":"info","ts":"2026-05-14T09:35:18.800268Z","caller":"traceutil/trace.go:171","msg":"trace[1739398458] transaction","detail":"{read_only:false; response_revision:1246; number_of_response:1; }","duration":"124.256968ms","start":"2026-05-14T09:35:18.675984Z","end":"2026-05-14T09:35:18.800241Z","steps":["trace[1739398458] 'process raft request' (duration: 124.093364ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:19.309571Z","caller":"traceutil/trace.go:171","msg":"trace[585748056] transaction","detail":"{read_only:false; response_revision:1249; number_of_response:1; }","duration":"130.689113ms","start":"2026-05-14T09:35:19.178856Z","end":"2026-05-14T09:35:19.309545Z","steps":["trace[585748056] 'process raft request' (duration: 130.450469ms)"],"step_count":1} {"level":"info","ts":"2026-05-14T09:35:19.309578Z","caller":"traceutil/trace.go:171","msg":"trace[421900668] linearizableReadLoop","detail":"{readStateIndex:1297; appliedIndex:1296; }","duration":"113.435376ms","start":"2026-05-14T09:35:19.196094Z","end":"2026-05-14T09:35:19.309529Z","steps":["trace[421900668] 'read index received' (duration: 113.161681ms)","trace[421900668] 'applied index is now lower than readState.Index' (duration: 272.485µs)"],"step_count":2} {"level":"warn","ts":"2026-05-14T09:35:19.309789Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.622939ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-14T09:35:19.309906Z","caller":"traceutil/trace.go:171","msg":"trace[1337819617] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1249; }","duration":"113.829324ms","start":"2026-05-14T09:35:19.19606Z","end":"2026-05-14T09:35:19.309889Z","steps":["trace[1337819617] 'agreement among raft nodes before linearized reading' (duration: 113.551028ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:19.62643Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.583015ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-14T09:35:19.626572Z","caller":"traceutil/trace.go:171","msg":"trace[2064083798] linearizableReadLoop","detail":"{readStateIndex:1299; appliedIndex:1297; }","duration":"153.281295ms","start":"2026-05-14T09:35:19.473271Z","end":"2026-05-14T09:35:19.626553Z","steps":["trace[2064083798] 'read index received' (duration: 142.332181ms)","trace[2064083798] 'applied index is now lower than readState.Index' (duration: 10.948594ms)"],"step_count":2} {"level":"info","ts":"2026-05-14T09:35:19.62663Z","caller":"traceutil/trace.go:171","msg":"trace[1254005046] transaction","detail":"{read_only:false; response_revision:1250; number_of_response:1; }","duration":"312.707131ms","start":"2026-05-14T09:35:19.313917Z","end":"2026-05-14T09:35:19.626625Z","steps":["trace[1254005046] 'process raft request' (duration: 59.785268ms)","trace[1254005046] 'compare' (duration: 252.360501ms)"],"step_count":2} {"level":"warn","ts":"2026-05-14T09:35:19.626665Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:35:19.313892Z","time spent":"312.759061ms","remote":"127.0.0.1:45234","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":836,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-14T09:35:19.626806Z","caller":"traceutil/trace.go:171","msg":"trace[1873294018] transaction","detail":"{read_only:false; response_revision:1251; number_of_response:1; }","duration":"309.60552ms","start":"2026-05-14T09:35:19.317196Z","end":"2026-05-14T09:35:19.626801Z","steps":["trace[1873294018] 'process raft request' (duration: 309.305234ms)"],"step_count":1} {"level":"warn","ts":"2026-05-14T09:35:19.626839Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-14T09:35:19.31718Z","time spent":"309.645001ms","remote":"127.0.0.1:45464","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":457,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-14T09:35:19.626818Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.501579ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-14T09:35:19.626926Z","caller":"traceutil/trace.go:171","msg":"trace[1958037373] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1251; }","duration":"153.688823ms","start":"2026-05-14T09:35:19.473216Z","end":"2026-05-14T09:35:19.626905Z","steps":["trace[1958037373] 'agreement among raft nodes before linearized reading' (duration: 153.448719ms)"],"step_count":1}