{"level":"warn","ts":"2026-04-20T10:43:45.736234Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-20T10:43:45.73632Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.222: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.222:2380","--initial-cluster=instance=https://199.204.45.222:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.222:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.222:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-04-20T10:43:45.736395Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-20T10:43:45.736408Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.222:2380"]} {"level":"info","ts":"2026-04-20T10:43:45.736424Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-20T10:43:45.738501Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"]} {"level":"info","ts":"2026-04-20T10:43:45.738591Z","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.222:2380"],"listen-peer-urls":["https://199.204.45.222:2380"],"advertise-client-urls":["https://199.204.45.222:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.222:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-04-20T10:43:45.744814Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.018456ms"} {"level":"info","ts":"2026-04-20T10:43:45.761596Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"380f6760faea5f9e","cluster-id":"b87e8aca83a17eab"} {"level":"info","ts":"2026-04-20T10:43:45.761708Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=()"} {"level":"info","ts":"2026-04-20T10:43:45.76174Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became follower at term 0"} {"level":"info","ts":"2026-04-20T10:43:45.761754Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 380f6760faea5f9e [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-20T10:43:45.761771Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became follower at term 1"} {"level":"info","ts":"2026-04-20T10:43:45.761832Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=(4039561056998809502)"} {"level":"warn","ts":"2026-04-20T10:43:45.771094Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-20T10:43:45.774099Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-20T10:43:45.775438Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-04-20T10:43:45.777665Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"380f6760faea5f9e","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-20T10:43:45.778172Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"380f6760faea5f9e","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-20T10:43:45.778266Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-20T10:43:45.778292Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-20T10:43:45.778298Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-20T10:43:45.780213Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e switched to configuration voters=(4039561056998809502)"} {"level":"info","ts":"2026-04-20T10:43:45.781371Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"b87e8aca83a17eab","local-member-id":"380f6760faea5f9e","added-peer-id":"380f6760faea5f9e","added-peer-peer-urls":["https://199.204.45.222:2380"]} {"level":"info","ts":"2026-04-20T10:43:45.782384Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-20T10:43:45.782435Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.222:2380"} {"level":"info","ts":"2026-04-20T10:43:45.782493Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.222:2380"} {"level":"info","ts":"2026-04-20T10:43:45.782639Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"380f6760faea5f9e","initial-advertise-peer-urls":["https://199.204.45.222:2380"],"listen-peer-urls":["https://199.204.45.222:2380"],"advertise-client-urls":["https://199.204.45.222:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.222:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-20T10:43:45.782681Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-20T10:43:46.362428Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e is starting a new election at term 1"} {"level":"info","ts":"2026-04-20T10:43:46.362496Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became pre-candidate at term 1"} {"level":"info","ts":"2026-04-20T10:43:46.362543Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e received MsgPreVoteResp from 380f6760faea5f9e at term 1"} {"level":"info","ts":"2026-04-20T10:43:46.362564Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became candidate at term 2"} {"level":"info","ts":"2026-04-20T10:43:46.362587Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e received MsgVoteResp from 380f6760faea5f9e at term 2"} {"level":"info","ts":"2026-04-20T10:43:46.362612Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"380f6760faea5f9e became leader at term 2"} {"level":"info","ts":"2026-04-20T10:43:46.362626Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 380f6760faea5f9e elected leader 380f6760faea5f9e at term 2"} {"level":"info","ts":"2026-04-20T10:43:46.363542Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"380f6760faea5f9e","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.222:2379]}","request-path":"/0/members/380f6760faea5f9e/attributes","cluster-id":"b87e8aca83a17eab","publish-timeout":"7s"} {"level":"info","ts":"2026-04-20T10:43:46.373713Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-20T10:43:46.373854Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T10:43:46.37524Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-20T10:43:46.375319Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"b87e8aca83a17eab","local-member-id":"380f6760faea5f9e","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T10:43:46.375438Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T10:43:46.375475Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T10:43:46.375523Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-20T10:43:46.378298Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.222:2379"} {"level":"info","ts":"2026-04-20T10:43:46.379128Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-20T10:43:46.37917Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-20T10:44:10.884839Z","caller":"traceutil/trace.go:171","msg":"trace[1079929187] transaction","detail":"{read_only:false; response_revision:468; number_of_response:1; }","duration":"395.259132ms","start":"2026-04-20T10:44:10.489542Z","end":"2026-04-20T10:44:10.884801Z","steps":["trace[1079929187] 'process raft request' (duration: 394.927858ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:10.885504Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:10.489522Z","time spent":"395.488315ms","remote":"127.0.0.1:38318","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":317292,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-20T10:44:14.13795Z","caller":"traceutil/trace.go:171","msg":"trace[983148360] transaction","detail":"{read_only:false; response_revision:563; number_of_response:1; }","duration":"363.013393ms","start":"2026-04-20T10:44:13.774909Z","end":"2026-04-20T10:44:14.137923Z","steps":["trace[983148360] 'process raft request' (duration: 362.82639ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:14.138131Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:13.774877Z","time spent":"363.152224ms","remote":"127.0.0.1:38266","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":73770,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-20T10:44:14.144751Z","caller":"traceutil/trace.go:171","msg":"trace[173503447] transaction","detail":"{read_only:false; response_revision:564; number_of_response:1; }","duration":"361.485221ms","start":"2026-04-20T10:44:13.78324Z","end":"2026-04-20T10:44:14.144725Z","steps":["trace[173503447] 'process raft request' (duration: 361.074075ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T10:44:14.144929Z","caller":"traceutil/trace.go:171","msg":"trace[774309443] linearizableReadLoop","detail":"{readStateIndex:582; appliedIndex:580; }","duration":"273.620417ms","start":"2026-04-20T10:44:13.871282Z","end":"2026-04-20T10:44:14.144902Z","steps":["trace[774309443] 'read index received' (duration: 266.887438ms)","trace[774309443] 'applied index is now lower than readState.Index' (duration: 6.732039ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T10:44:14.145538Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:13.783215Z","time spent":"361.591263ms","remote":"127.0.0.1:38266","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":98698,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-20T10:44:14.144963Z","caller":"traceutil/trace.go:171","msg":"trace[664228370] transaction","detail":"{read_only:false; response_revision:565; number_of_response:1; }","duration":"336.268847ms","start":"2026-04-20T10:44:13.808658Z","end":"2026-04-20T10:44:14.144926Z","steps":["trace[664228370] 'process raft request' (duration: 335.997884ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:14.145756Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:13.808611Z","time spent":"337.089207ms","remote":"127.0.0.1:38266","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":151212,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T10:44:14.145887Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.612569ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-20T10:44:14.145969Z","caller":"traceutil/trace.go:171","msg":"trace[1631174396] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:565; }","duration":"274.729701ms","start":"2026-04-20T10:44:13.871208Z","end":"2026-04-20T10:44:14.145938Z","steps":["trace[1631174396] 'agreement among raft nodes before linearized reading' (duration: 273.771569ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:14.146511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.975348ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-04-20T10:44:14.146561Z","caller":"traceutil/trace.go:171","msg":"trace[838956041] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:565; }","duration":"227.060009ms","start":"2026-04-20T10:44:13.919476Z","end":"2026-04-20T10:44:14.146536Z","steps":["trace[838956041] 'agreement among raft nodes before linearized reading' (duration: 226.977438ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:14.146845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"223.476232ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-20T10:44:14.1469Z","caller":"traceutil/trace.go:171","msg":"trace[290215051] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:565; }","duration":"223.573663ms","start":"2026-04-20T10:44:13.923304Z","end":"2026-04-20T10:44:14.146878Z","steps":["trace[290215051] 'agreement among raft nodes before linearized reading' (duration: 223.474872ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T10:44:19.295918Z","caller":"traceutil/trace.go:171","msg":"trace[369562643] linearizableReadLoop","detail":"{readStateIndex:622; appliedIndex:621; }","duration":"139.986375ms","start":"2026-04-20T10:44:19.155892Z","end":"2026-04-20T10:44:19.295879Z","steps":["trace[369562643] 'read index received' (duration: 138.88348ms)","trace[369562643] 'applied index is now lower than readState.Index' (duration: 1.101725ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T10:44:19.296003Z","caller":"traceutil/trace.go:171","msg":"trace[750519270] transaction","detail":"{read_only:false; response_revision:604; number_of_response:1; }","duration":"173.783248ms","start":"2026-04-20T10:44:19.122185Z","end":"2026-04-20T10:44:19.295968Z","steps":["trace[750519270] 'process raft request' (duration: 172.904386ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:19.296357Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.42036ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-2gs6k\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-04-20T10:44:19.296802Z","caller":"traceutil/trace.go:171","msg":"trace[313637151] range","detail":"{range_begin:/registry/pods/kube-system/cilium-2gs6k; range_end:; response_count:1; response_revision:604; }","duration":"140.616213ms","start":"2026-04-20T10:44:19.155831Z","end":"2026-04-20T10:44:19.296447Z","steps":["trace[313637151] 'agreement among raft nodes before linearized reading' (duration: 140.170767ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T10:44:19.845975Z","caller":"traceutil/trace.go:171","msg":"trace[1558765806] transaction","detail":"{read_only:false; response_revision:605; number_of_response:1; }","duration":"525.229165ms","start":"2026-04-20T10:44:19.32071Z","end":"2026-04-20T10:44:19.845939Z","steps":["trace[1558765806] 'process raft request' (duration: 442.375012ms)","trace[1558765806] 'compare' (duration: 82.057792ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T10:44:19.84621Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:19.320686Z","time spent":"525.390187ms","remote":"127.0.0.1:38412","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-20T10:44:19.846172Z","caller":"traceutil/trace.go:171","msg":"trace[1530031935] linearizableReadLoop","detail":"{readStateIndex:624; appliedIndex:622; }","duration":"471.818369ms","start":"2026-04-20T10:44:19.374295Z","end":"2026-04-20T10:44:19.846113Z","steps":["trace[1530031935] 'read index received' (duration: 388.818295ms)","trace[1530031935] 'applied index is now lower than readState.Index' (duration: 82.998284ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T10:44:19.846295Z","caller":"traceutil/trace.go:171","msg":"trace[1970883003] transaction","detail":"{read_only:false; response_revision:606; number_of_response:1; }","duration":"476.090264ms","start":"2026-04-20T10:44:19.370172Z","end":"2026-04-20T10:44:19.846263Z","steps":["trace[1970883003] 'process raft request' (duration: 475.519436ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:19.846449Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:19.370087Z","time spent":"476.279166ms","remote":"127.0.0.1:38564","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":897,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-20T10:44:19.84646Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"472.134033ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T10:44:19.846522Z","caller":"traceutil/trace.go:171","msg":"trace[1050687799] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:606; }","duration":"472.262435ms","start":"2026-04-20T10:44:19.374248Z","end":"2026-04-20T10:44:19.84651Z","steps":["trace[1050687799] 'agreement among raft nodes before linearized reading' (duration: 472.101993ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:19.84658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:19.374233Z","time spent":"472.337096ms","remote":"127.0.0.1:38216","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-04-20T10:44:19.846621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"442.532343ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.222\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-04-20T10:44:19.846669Z","caller":"traceutil/trace.go:171","msg":"trace[1065607941] range","detail":"{range_begin:/registry/masterleases/199.204.45.222; range_end:; response_count:1; response_revision:606; }","duration":"442.679506ms","start":"2026-04-20T10:44:19.403975Z","end":"2026-04-20T10:44:19.846654Z","steps":["trace[1065607941] 'agreement among raft nodes before linearized reading' (duration: 442.586865ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:19.846707Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:19.403951Z","time spent":"442.747876ms","remote":"127.0.0.1:38254","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":158,"request content":"key:\"/registry/masterleases/199.204.45.222\" "} {"level":"warn","ts":"2026-04-20T10:44:19.846823Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.382121ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-20T10:44:19.846868Z","caller":"traceutil/trace.go:171","msg":"trace[1658455250] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:606; }","duration":"222.485712ms","start":"2026-04-20T10:44:19.624369Z","end":"2026-04-20T10:44:19.846855Z","steps":["trace[1658455250] 'agreement among raft nodes before linearized reading' (duration: 222.390411ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:20.879255Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":6890117835494123025,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-20T10:44:21.379642Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":6890117835494123025,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-20T10:44:21.47703Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.172733753s","expected-duration":"1s"} {"level":"warn","ts":"2026-04-20T10:44:21.479772Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.284311095s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-04-20T10:44:21.479835Z","caller":"traceutil/trace.go:171","msg":"trace[82852774] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:608; }","duration":"1.284404816s","start":"2026-04-20T10:44:20.195408Z","end":"2026-04-20T10:44:21.479813Z","steps":["trace[82852774] 'range keys from in-memory index tree' (duration: 1.284222445s)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:21.479882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:20.195399Z","time spent":"1.284474128s","remote":"127.0.0.1:38498","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-04-20T10:44:21.480154Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.29089835s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-04-20T10:44:21.480182Z","caller":"traceutil/trace.go:171","msg":"trace[1965476737] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:608; }","duration":"1.29096236s","start":"2026-04-20T10:44:20.189211Z","end":"2026-04-20T10:44:21.480173Z","steps":["trace[1965476737] 'range keys from in-memory index tree' (duration: 1.290830069s)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:21.480208Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:20.189159Z","time spent":"1.291043512s","remote":"127.0.0.1:38498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-04-20T10:44:21.480558Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.285082696s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-20T10:44:21.480589Z","caller":"traceutil/trace.go:171","msg":"trace[1831080634] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:608; }","duration":"1.285174326s","start":"2026-04-20T10:44:20.195405Z","end":"2026-04-20T10:44:21.480579Z","steps":["trace[1831080634] 'range keys from in-memory index tree' (duration: 1.284967104s)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:21.480615Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:20.195326Z","time spent":"1.285282688s","remote":"127.0.0.1:38498","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-04-20T10:44:21.483947Z","caller":"traceutil/trace.go:171","msg":"trace[1714704189] linearizableReadLoop","detail":"{readStateIndex:628; appliedIndex:627; }","duration":"1.105713937s","start":"2026-04-20T10:44:20.378196Z","end":"2026-04-20T10:44:21.48391Z","steps":["trace[1714704189] 'read index received' (duration: 1.099203445s)","trace[1714704189] 'applied index is now lower than readState.Index' (duration: 6.509252ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T10:44:21.484137Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.105910341s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T10:44:21.484163Z","caller":"traceutil/trace.go:171","msg":"trace[419103410] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:609; }","duration":"1.106000812s","start":"2026-04-20T10:44:20.378154Z","end":"2026-04-20T10:44:21.484155Z","steps":["trace[419103410] 'agreement among raft nodes before linearized reading' (duration: 1.10587039s)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:21.484192Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:20.378135Z","time spent":"1.106050363s","remote":"127.0.0.1:38220","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-04-20T10:44:21.485155Z","caller":"traceutil/trace.go:171","msg":"trace[1685558704] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"1.185961341s","start":"2026-04-20T10:44:20.299184Z","end":"2026-04-20T10:44:21.485145Z","steps":["trace[1685558704] 'process raft request' (duration: 1.178507357s)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:21.485242Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:20.299146Z","time spent":"1.186029152s","remote":"127.0.0.1:38318","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036081,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-20T10:44:23.462794Z","caller":"traceutil/trace.go:171","msg":"trace[779590199] transaction","detail":"{read_only:false; response_revision:651; number_of_response:1; }","duration":"100.774585ms","start":"2026-04-20T10:44:23.361967Z","end":"2026-04-20T10:44:23.462741Z","steps":["trace[779590199] 'process raft request' (duration: 100.569172ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.566817Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"991.860602ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-04-20T10:44:38.56696Z","caller":"traceutil/trace.go:171","msg":"trace[1794686706] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:781; }","duration":"992.056445ms","start":"2026-04-20T10:44:37.574885Z","end":"2026-04-20T10:44:38.566941Z","steps":["trace[1794686706] 'range keys from in-memory index tree' (duration: 991.66546ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.567003Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:37.574867Z","time spent":"992.125437ms","remote":"127.0.0.1:38498","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-04-20T10:44:38.56721Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"982.814787ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-20T10:44:38.567301Z","caller":"traceutil/trace.go:171","msg":"trace[308209211] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:781; }","duration":"982.955739ms","start":"2026-04-20T10:44:37.584324Z","end":"2026-04-20T10:44:38.56728Z","steps":["trace[308209211] 'range keys from in-memory index tree' (duration: 982.614465ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.567313Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"588.661191ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-20T10:44:38.567361Z","caller":"traceutil/trace.go:171","msg":"trace[388692588] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:781; }","duration":"588.735692ms","start":"2026-04-20T10:44:37.978612Z","end":"2026-04-20T10:44:38.567348Z","steps":["trace[388692588] 'range keys from in-memory index tree' (duration: 587.881691ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.567369Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:37.584298Z","time spent":"983.05425ms","remote":"127.0.0.1:38498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-04-20T10:44:38.567399Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:37.978598Z","time spent":"588.793102ms","remote":"127.0.0.1:38498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-04-20T10:44:38.567441Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"982.513094ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-20T10:44:38.567642Z","caller":"traceutil/trace.go:171","msg":"trace[808598091] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:781; }","duration":"982.742276ms","start":"2026-04-20T10:44:37.584846Z","end":"2026-04-20T10:44:38.567588Z","steps":["trace[808598091] 'range keys from in-memory index tree' (duration: 982.269371ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.567706Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:37.584834Z","time spent":"982.860787ms","remote":"127.0.0.1:38498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-04-20T10:44:38.591146Z","caller":"traceutil/trace.go:171","msg":"trace[393592905] linearizableReadLoop","detail":"{readStateIndex:806; appliedIndex:805; }","duration":"213.785748ms","start":"2026-04-20T10:44:38.377331Z","end":"2026-04-20T10:44:38.591117Z","steps":["trace[393592905] 'read index received' (duration: 213.522815ms)","trace[393592905] 'applied index is now lower than readState.Index' (duration: 261.553µs)"],"step_count":2} {"level":"info","ts":"2026-04-20T10:44:38.591186Z","caller":"traceutil/trace.go:171","msg":"trace[1468130614] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"305.428739ms","start":"2026-04-20T10:44:38.285721Z","end":"2026-04-20T10:44:38.59115Z","steps":["trace[1468130614] 'process raft request' (duration: 305.154856ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:44:38.59131Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T10:44:38.285695Z","time spent":"305.549321ms","remote":"127.0.0.1:38454","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T10:44:38.591331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"213.958221ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T10:44:38.591373Z","caller":"traceutil/trace.go:171","msg":"trace[259526203] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:782; }","duration":"214.160793ms","start":"2026-04-20T10:44:38.377198Z","end":"2026-04-20T10:44:38.591359Z","steps":["trace[259526203] 'agreement among raft nodes before linearized reading' (duration: 214.036552ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T10:44:38.603555Z","caller":"traceutil/trace.go:171","msg":"trace[208699237] transaction","detail":"{read_only:false; response_revision:783; number_of_response:1; }","duration":"155.792851ms","start":"2026-04-20T10:44:38.447743Z","end":"2026-04-20T10:44:38.603536Z","steps":["trace[208699237] 'process raft request' (duration: 155.616968ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T10:45:13.553492Z","caller":"traceutil/trace.go:171","msg":"trace[975660450] linearizableReadLoop","detail":"{readStateIndex:1082; appliedIndex:1081; }","duration":"245.843104ms","start":"2026-04-20T10:45:13.307618Z","end":"2026-04-20T10:45:13.553461Z","steps":["trace[975660450] 'read index received' (duration: 245.709903ms)","trace[975660450] 'applied index is now lower than readState.Index' (duration: 131.531µs)"],"step_count":2} {"level":"info","ts":"2026-04-20T10:45:13.55358Z","caller":"traceutil/trace.go:171","msg":"trace[975261537] transaction","detail":"{read_only:false; response_revision:1048; number_of_response:1; }","duration":"275.860523ms","start":"2026-04-20T10:45:13.277684Z","end":"2026-04-20T10:45:13.553544Z","steps":["trace[975261537] 'process raft request' (duration: 275.528218ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:45:13.5537Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.015924ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T10:45:13.553746Z","caller":"traceutil/trace.go:171","msg":"trace[1366235008] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1048; }","duration":"176.133986ms","start":"2026-04-20T10:45:13.3776Z","end":"2026-04-20T10:45:13.553734Z","steps":["trace[1366235008] 'agreement among raft nodes before linearized reading' (duration: 176.036995ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:45:13.554052Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.788868ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-74f37cfe-a9e2-47fe-9ed7-7b2572fe5b6e\" ","response":"range_response_count:1 size:3579"} {"level":"info","ts":"2026-04-20T10:45:13.554107Z","caller":"traceutil/trace.go:171","msg":"trace[1196817684] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-74f37cfe-a9e2-47fe-9ed7-7b2572fe5b6e; range_end:; response_count:1; response_revision:1048; }","duration":"133.89354ms","start":"2026-04-20T10:45:13.420198Z","end":"2026-04-20T10:45:13.554092Z","steps":["trace[1196817684] 'agreement among raft nodes before linearized reading' (duration: 133.569437ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T10:45:13.554402Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"246.737132ms","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-04-20T10:45:13.554529Z","caller":"traceutil/trace.go:171","msg":"trace[1720147074] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:1048; }","duration":"246.957645ms","start":"2026-04-20T10:45:13.307547Z","end":"2026-04-20T10:45:13.554504Z","steps":["trace[1720147074] 'agreement among raft nodes before linearized reading' (duration: 246.064966ms)"],"step_count":1}