{"level":"warn","ts":"2026-05-06T12:39:37.135467Z","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-06T12:39:37.135589Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.238:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.238:2380","--initial-cluster=instance=https://199.19.213.238:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.238:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.238: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-06T12:39:37.135681Z","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-06T12:39:37.135693Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.238:2380"]} {"level":"info","ts":"2026-05-06T12:39:37.13572Z","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-06T12:39:37.136539Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.238:2379"]} {"level":"info","ts":"2026-05-06T12:39:37.136624Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.238:2380"],"listen-peer-urls":["https://199.19.213.238:2380"],"advertise-client-urls":["https://199.19.213.238:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.238:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.238: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-06T12:39:37.140196Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.379753ms"} {"level":"info","ts":"2026-05-06T12:39:37.152342Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"8cf6035374726417","cluster-id":"e837e6e114b087e2"} {"level":"info","ts":"2026-05-06T12:39:37.152437Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 switched to configuration voters=()"} {"level":"info","ts":"2026-05-06T12:39:37.152467Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 became follower at term 0"} {"level":"info","ts":"2026-05-06T12:39:37.152482Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 8cf6035374726417 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-06T12:39:37.152499Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 became follower at term 1"} {"level":"info","ts":"2026-05-06T12:39:37.152548Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 switched to configuration voters=(10157309666551555095)"} {"level":"warn","ts":"2026-05-06T12:39:37.169463Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-06T12:39:37.17601Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-06T12:39:37.301509Z","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-06T12:39:37.3055Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"8cf6035374726417","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-06T12:39:37.306048Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"8cf6035374726417","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-06T12:39:37.306203Z","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-06T12:39:37.30641Z","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-06T12:39:37.306504Z","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-06T12:39:37.30755Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 switched to configuration voters=(10157309666551555095)"} {"level":"info","ts":"2026-05-06T12:39:37.310009Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"e837e6e114b087e2","local-member-id":"8cf6035374726417","added-peer-id":"8cf6035374726417","added-peer-peer-urls":["https://199.19.213.238:2380"]} {"level":"info","ts":"2026-05-06T12:39:37.312696Z","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-06T12:39:37.312903Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"8cf6035374726417","initial-advertise-peer-urls":["https://199.19.213.238:2380"],"listen-peer-urls":["https://199.19.213.238:2380"],"advertise-client-urls":["https://199.19.213.238:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.238:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-06T12:39:37.312939Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-06T12:39:37.313011Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.238:2380"} {"level":"info","ts":"2026-05-06T12:39:37.313031Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.238:2380"} {"level":"info","ts":"2026-05-06T12:39:37.653455Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 is starting a new election at term 1"} {"level":"info","ts":"2026-05-06T12:39:37.653542Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 became pre-candidate at term 1"} {"level":"info","ts":"2026-05-06T12:39:37.65359Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 received MsgPreVoteResp from 8cf6035374726417 at term 1"} {"level":"info","ts":"2026-05-06T12:39:37.653614Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 became candidate at term 2"} {"level":"info","ts":"2026-05-06T12:39:37.653626Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 received MsgVoteResp from 8cf6035374726417 at term 2"} {"level":"info","ts":"2026-05-06T12:39:37.653644Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8cf6035374726417 became leader at term 2"} {"level":"info","ts":"2026-05-06T12:39:37.653659Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 8cf6035374726417 elected leader 8cf6035374726417 at term 2"} {"level":"info","ts":"2026-05-06T12:39:37.654512Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"8cf6035374726417","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.238:2379]}","request-path":"/0/members/8cf6035374726417/attributes","cluster-id":"e837e6e114b087e2","publish-timeout":"7s"} {"level":"info","ts":"2026-05-06T12:39:37.654722Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-06T12:39:37.654786Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-06T12:39:37.654897Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T12:39:37.655091Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-06T12:39:37.65513Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-06T12:39:37.655516Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"e837e6e114b087e2","local-member-id":"8cf6035374726417","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T12:39:37.655744Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T12:39:37.655808Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T12:39:37.657127Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-06T12:39:37.679346Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.238:2379"} {"level":"info","ts":"2026-05-06T12:39:41.658163Z","caller":"traceutil/trace.go:171","msg":"trace[524690502] transaction","detail":"{read_only:false; response_revision:205; number_of_response:1; }","duration":"239.438254ms","start":"2026-05-06T12:39:41.418702Z","end":"2026-05-06T12:39:41.65814Z","steps":["trace[524690502] 'process raft request' (duration: 239.272335ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:39:41.971165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.830077ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-06T12:39:41.971323Z","caller":"traceutil/trace.go:171","msg":"trace[1424972908] transaction","detail":"{read_only:false; response_revision:206; number_of_response:1; }","duration":"304.630183ms","start":"2026-05-06T12:39:41.666659Z","end":"2026-05-06T12:39:41.971289Z","steps":["trace[1424972908] 'process raft request' (duration: 149.129091ms)","trace[1424972908] 'compare' (duration: 154.661599ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:39:41.97136Z","caller":"traceutil/trace.go:171","msg":"trace[825025240] linearizableReadLoop","detail":"{readStateIndex:211; appliedIndex:210; }","duration":"219.76953ms","start":"2026-05-06T12:39:41.751512Z","end":"2026-05-06T12:39:41.971282Z","steps":["trace[825025240] 'read index received' (duration: 64.357587ms)","trace[825025240] 'applied index is now lower than readState.Index' (duration: 155.410713ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T12:39:41.971476Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T12:39:41.66663Z","time spent":"304.767142ms","remote":"127.0.0.1:53342","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":525,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-06T12:39:41.971601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.077629ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T12:39:41.971746Z","caller":"traceutil/trace.go:171","msg":"trace[568812829] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:206; }","duration":"220.231718ms","start":"2026-05-06T12:39:41.751472Z","end":"2026-05-06T12:39:41.971703Z","steps":["trace[568812829] 'agreement among raft nodes before linearized reading' (duration: 220.010418ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.024952Z","caller":"traceutil/trace.go:171","msg":"trace[447026107] transaction","detail":"{read_only:false; response_revision:469; number_of_response:1; }","duration":"108.992528ms","start":"2026-05-06T12:40:07.915933Z","end":"2026-05-06T12:40:08.024926Z","steps":["trace[447026107] 'process raft request' (duration: 108.810484ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.157439Z","caller":"traceutil/trace.go:171","msg":"trace[1999170018] transaction","detail":"{read_only:false; response_revision:470; number_of_response:1; }","duration":"226.15552ms","start":"2026-05-06T12:40:07.931228Z","end":"2026-05-06T12:40:08.157384Z","steps":["trace[1999170018] 'process raft request' (duration: 184.115755ms)","trace[1999170018] 'compare' (duration: 41.794491ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:40:08.157662Z","caller":"traceutil/trace.go:171","msg":"trace[1444690360] transaction","detail":"{read_only:false; response_revision:472; number_of_response:1; }","duration":"207.611662ms","start":"2026-05-06T12:40:07.950023Z","end":"2026-05-06T12:40:08.157634Z","steps":["trace[1444690360] 'process raft request' (duration: 207.340397ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.157829Z","caller":"traceutil/trace.go:171","msg":"trace[1398380121] transaction","detail":"{read_only:false; response_revision:471; number_of_response:1; }","duration":"215.558462ms","start":"2026-05-06T12:40:07.94226Z","end":"2026-05-06T12:40:08.157818Z","steps":["trace[1398380121] 'process raft request' (duration: 215.040252ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.158213Z","caller":"traceutil/trace.go:171","msg":"trace[1048985315] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"205.042474ms","start":"2026-05-06T12:40:07.953142Z","end":"2026-05-06T12:40:08.158184Z","steps":["trace[1048985315] 'process raft request' (duration: 204.375101ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.158986Z","caller":"traceutil/trace.go:171","msg":"trace[581880230] transaction","detail":"{read_only:false; response_revision:479; number_of_response:1; }","duration":"179.283581ms","start":"2026-05-06T12:40:07.97968Z","end":"2026-05-06T12:40:08.158964Z","steps":["trace[581880230] 'process raft request' (duration: 179.21857ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.160633Z","caller":"traceutil/trace.go:171","msg":"trace[995736482] transaction","detail":"{read_only:false; response_revision:474; number_of_response:1; }","duration":"204.691359ms","start":"2026-05-06T12:40:07.955918Z","end":"2026-05-06T12:40:08.160609Z","steps":["trace[995736482] 'process raft request' (duration: 202.345053ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.160904Z","caller":"traceutil/trace.go:171","msg":"trace[668109126] transaction","detail":"{read_only:false; response_revision:475; number_of_response:1; }","duration":"201.020829ms","start":"2026-05-06T12:40:07.959864Z","end":"2026-05-06T12:40:08.160885Z","steps":["trace[668109126] 'process raft request' (duration: 198.683104ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.160918Z","caller":"traceutil/trace.go:171","msg":"trace[1508601119] transaction","detail":"{read_only:false; response_revision:478; number_of_response:1; }","duration":"182.88425ms","start":"2026-05-06T12:40:07.978015Z","end":"2026-05-06T12:40:08.160899Z","steps":["trace[1508601119] 'process raft request' (duration: 180.733659ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.161028Z","caller":"traceutil/trace.go:171","msg":"trace[65030451] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"193.185923ms","start":"2026-05-06T12:40:07.967815Z","end":"2026-05-06T12:40:08.161001Z","steps":["trace[65030451] 'process raft request' (duration: 190.802338ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.161222Z","caller":"traceutil/trace.go:171","msg":"trace[461790096] transaction","detail":"{read_only:false; response_revision:477; number_of_response:1; }","duration":"186.203242ms","start":"2026-05-06T12:40:07.975004Z","end":"2026-05-06T12:40:08.161207Z","steps":["trace[461790096] 'process raft request' (duration: 183.676014ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.217722Z","caller":"traceutil/trace.go:171","msg":"trace[1582200450] transaction","detail":"{read_only:false; number_of_response:1; response_revision:481; }","duration":"181.796017ms","start":"2026-05-06T12:40:08.035898Z","end":"2026-05-06T12:40:08.217694Z","steps":["trace[1582200450] 'process raft request' (duration: 181.747196ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.217727Z","caller":"traceutil/trace.go:171","msg":"trace[1452275907] transaction","detail":"{read_only:false; response_revision:480; number_of_response:1; }","duration":"183.914957ms","start":"2026-05-06T12:40:08.033769Z","end":"2026-05-06T12:40:08.217684Z","steps":["trace[1452275907] 'process raft request' (duration: 183.711754ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:08.218203Z","caller":"traceutil/trace.go:171","msg":"trace[483470402] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"183.142273ms","start":"2026-05-06T12:40:08.03486Z","end":"2026-05-06T12:40:08.218003Z","steps":["trace[483470402] 'process raft request' (duration: 182.726965ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:40:14.245886Z","caller":"traceutil/trace.go:171","msg":"trace[914219427] transaction","detail":"{read_only:false; response_revision:576; number_of_response:1; }","duration":"149.417723ms","start":"2026-05-06T12:40:14.096434Z","end":"2026-05-06T12:40:14.245852Z","steps":["trace[914219427] 'process raft request' (duration: 149.237828ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:40:14.823556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"535.220811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-05-06T12:40:14.82371Z","caller":"traceutil/trace.go:171","msg":"trace[719728532] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:576; }","duration":"535.455066ms","start":"2026-05-06T12:40:14.288228Z","end":"2026-05-06T12:40:14.823683Z","steps":["trace[719728532] 'range keys from in-memory index tree' (duration: 534.960885ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:40:14.823763Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T12:40:14.288202Z","time spent":"535.550127ms","remote":"127.0.0.1:53512","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-06T12:40:14.823863Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"541.307779ms","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-05-06T12:40:14.824012Z","caller":"traceutil/trace.go:171","msg":"trace[1856192867] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:576; }","duration":"541.530234ms","start":"2026-05-06T12:40:14.282446Z","end":"2026-05-06T12:40:14.823976Z","steps":["trace[1856192867] 'range keys from in-memory index tree' (duration: 540.755047ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:40:14.824077Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T12:40:14.282413Z","time spent":"541.651407ms","remote":"127.0.0.1:53512","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":"info","ts":"2026-05-06T12:40:14.857199Z","caller":"traceutil/trace.go:171","msg":"trace[1093149111] linearizableReadLoop","detail":"{readStateIndex:600; appliedIndex:599; }","duration":"144.652123ms","start":"2026-05-06T12:40:14.712518Z","end":"2026-05-06T12:40:14.85717Z","steps":["trace[1093149111] 'read index received' (duration: 143.489736ms)","trace[1093149111] 'applied index is now lower than readState.Index' (duration: 1.160777ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:40:14.857334Z","caller":"traceutil/trace.go:171","msg":"trace[824873918] transaction","detail":"{read_only:false; response_revision:577; number_of_response:1; }","duration":"464.017415ms","start":"2026-05-06T12:40:14.393294Z","end":"2026-05-06T12:40:14.857311Z","steps":["trace[824873918] 'process raft request' (duration: 462.97243ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:40:14.857377Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.840797ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-06T12:40:14.857426Z","caller":"traceutil/trace.go:171","msg":"trace[1507514668] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:577; }","duration":"144.94836ms","start":"2026-05-06T12:40:14.71246Z","end":"2026-05-06T12:40:14.857408Z","steps":["trace[1507514668] 'agreement among raft nodes before linearized reading' (duration: 144.852208ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:40:14.857666Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T12:40:14.393259Z","time spent":"464.138718ms","remote":"127.0.0.1:53342","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-06T12:40:14.876467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.609053ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T12:40:14.876559Z","caller":"traceutil/trace.go:171","msg":"trace[764991104] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:579; }","duration":"130.767816ms","start":"2026-05-06T12:40:14.745773Z","end":"2026-05-06T12:40:14.876541Z","steps":["trace[764991104] 'agreement among raft nodes before linearized reading' (duration: 130.593082ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:41:21.619053Z","caller":"traceutil/trace.go:171","msg":"trace[1558459631] transaction","detail":"{read_only:false; response_revision:1408; number_of_response:1; }","duration":"123.272351ms","start":"2026-05-06T12:41:21.495756Z","end":"2026-05-06T12:41:21.619028Z","steps":["trace[1558459631] 'process raft request' (duration: 123.131491ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:41:46.500921Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.377747ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-06T12:41:46.501047Z","caller":"traceutil/trace.go:171","msg":"trace[816515103] transaction","detail":"{read_only:false; response_revision:1821; number_of_response:1; }","duration":"178.990609ms","start":"2026-05-06T12:41:46.322037Z","end":"2026-05-06T12:41:46.501027Z","steps":["trace[816515103] 'process raft request' (duration: 48.42829ms)","trace[816515103] 'compare' (duration: 130.238166ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:41:46.684857Z","caller":"traceutil/trace.go:171","msg":"trace[582347616] linearizableReadLoop","detail":"{readStateIndex:1891; appliedIndex:1890; }","duration":"189.042041ms","start":"2026-05-06T12:41:46.495796Z","end":"2026-05-06T12:41:46.684838Z","steps":["trace[582347616] 'read index received' (duration: 188.879549ms)","trace[582347616] 'applied index is now lower than readState.Index' (duration: 161.892µs)"],"step_count":2} {"level":"warn","ts":"2026-05-06T12:41:46.684976Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.164192ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumnetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T12:41:46.68496Z","caller":"traceutil/trace.go:171","msg":"trace[1318066927] transaction","detail":"{read_only:false; response_revision:1822; number_of_response:1; }","duration":"238.095217ms","start":"2026-05-06T12:41:46.446823Z","end":"2026-05-06T12:41:46.684918Z","steps":["trace[1318066927] 'process raft request' (duration: 237.901975ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:41:46.685022Z","caller":"traceutil/trace.go:171","msg":"trace[701424464] range","detail":"{range_begin:/registry/cilium.io/ciliumnetworkpolicies/; range_end:/registry/cilium.io/ciliumnetworkpolicies0; response_count:0; response_revision:1822; }","duration":"189.262924ms","start":"2026-05-06T12:41:46.495749Z","end":"2026-05-06T12:41:46.685012Z","steps":["trace[701424464] 'agreement among raft nodes before linearized reading' (duration: 189.180353ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:41:46.685163Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.85111ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-06T12:41:46.685241Z","caller":"traceutil/trace.go:171","msg":"trace[275526656] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1822; }","duration":"109.986542ms","start":"2026-05-06T12:41:46.575237Z","end":"2026-05-06T12:41:46.685223Z","steps":["trace[275526656] 'agreement among raft nodes before linearized reading' (duration: 109.7788ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:41:46.852404Z","caller":"traceutil/trace.go:171","msg":"trace[1913848416] linearizableReadLoop","detail":"{readStateIndex:1893; appliedIndex:1892; }","duration":"123.221346ms","start":"2026-05-06T12:41:46.729154Z","end":"2026-05-06T12:41:46.852375Z","steps":["trace[1913848416] 'read index received' (duration: 123.030984ms)","trace[1913848416] 'applied index is now lower than readState.Index' (duration: 189.342µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:41:46.852437Z","caller":"traceutil/trace.go:171","msg":"trace[1450515221] transaction","detail":"{read_only:false; response_revision:1824; number_of_response:1; }","duration":"159.090068ms","start":"2026-05-06T12:41:46.693318Z","end":"2026-05-06T12:41:46.852408Z","steps":["trace[1450515221] 'process raft request' (duration: 158.882056ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T12:41:46.85273Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.555609ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5412"} {"level":"info","ts":"2026-05-06T12:41:46.852823Z","caller":"traceutil/trace.go:171","msg":"trace[1569067618] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1824; }","duration":"123.7043ms","start":"2026-05-06T12:41:46.729097Z","end":"2026-05-06T12:41:46.852801Z","steps":["trace[1569067618] 'agreement among raft nodes before linearized reading' (duration: 123.436707ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:41:47.048513Z","caller":"traceutil/trace.go:171","msg":"trace[238502677] linearizableReadLoop","detail":"{readStateIndex:1894; appliedIndex:1893; }","duration":"195.990606ms","start":"2026-05-06T12:41:46.852476Z","end":"2026-05-06T12:41:47.048466Z","steps":["trace[238502677] 'read index received' (duration: 180.742066ms)","trace[238502677] 'applied index is now lower than readState.Index' (duration: 15.24741ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T12:41:47.048776Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.877921ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-06T12:41:47.048809Z","caller":"traceutil/trace.go:171","msg":"trace[1112721523] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1825; }","duration":"249.959701ms","start":"2026-05-06T12:41:46.798834Z","end":"2026-05-06T12:41:47.048794Z","steps":["trace[1112721523] 'agreement among raft nodes before linearized reading' (duration: 249.78643ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:41:47.048571Z","caller":"traceutil/trace.go:171","msg":"trace[770249305] transaction","detail":"{read_only:false; response_revision:1825; number_of_response:1; }","duration":"291.185779ms","start":"2026-05-06T12:41:46.75736Z","end":"2026-05-06T12:41:47.048546Z","steps":["trace[770249305] 'process raft request' (duration: 275.830598ms)","trace[770249305] 'compare' (duration: 15.004867ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:42:02.333184Z","caller":"traceutil/trace.go:171","msg":"trace[2061429002] transaction","detail":"{read_only:false; response_revision:1952; number_of_response:1; }","duration":"162.264223ms","start":"2026-05-06T12:42:02.170893Z","end":"2026-05-06T12:42:02.333157Z","steps":["trace[2061429002] 'process raft request' (duration: 161.767406ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:42:02.33319Z","caller":"traceutil/trace.go:171","msg":"trace[1160922867] linearizableReadLoop","detail":"{readStateIndex:2025; appliedIndex:2024; }","duration":"142.00337ms","start":"2026-05-06T12:42:02.191147Z","end":"2026-05-06T12:42:02.333151Z","steps":["trace[1160922867] 'read index received' (duration: 141.483822ms)","trace[1160922867] 'applied index is now lower than readState.Index' (duration: 518.348µs)"],"step_count":2} {"level":"warn","ts":"2026-05-06T12:42:02.333452Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.273954ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-05-06T12:42:02.33351Z","caller":"traceutil/trace.go:171","msg":"trace[687597261] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1952; }","duration":"142.386286ms","start":"2026-05-06T12:42:02.191111Z","end":"2026-05-06T12:42:02.333497Z","steps":["trace[687597261] 'agreement among raft nodes before linearized reading' (duration: 142.132772ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:42:19.269676Z","caller":"traceutil/trace.go:171","msg":"trace[1390063054] transaction","detail":"{read_only:false; response_revision:2059; number_of_response:1; }","duration":"113.768543ms","start":"2026-05-06T12:42:19.15588Z","end":"2026-05-06T12:42:19.269648Z","steps":["trace[1390063054] 'process raft request' (duration: 113.61462ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:42:19.417072Z","caller":"traceutil/trace.go:171","msg":"trace[718295028] transaction","detail":"{read_only:false; response_revision:2060; number_of_response:1; }","duration":"252.263803ms","start":"2026-05-06T12:42:19.164788Z","end":"2026-05-06T12:42:19.417052Z","steps":["trace[718295028] 'process raft request' (duration: 182.507218ms)","trace[718295028] 'compare' (duration: 69.558801ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:43:28.957388Z","caller":"traceutil/trace.go:171","msg":"trace[1668737760] transaction","detail":"{read_only:false; response_revision:2536; number_of_response:1; }","duration":"164.653543ms","start":"2026-05-06T12:43:28.792717Z","end":"2026-05-06T12:43:28.957371Z","steps":["trace[1668737760] 'process raft request' (duration: 164.559291ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:44:01.476058Z","caller":"traceutil/trace.go:171","msg":"trace[2088700149] transaction","detail":"{read_only:false; response_revision:2715; number_of_response:1; }","duration":"104.987881ms","start":"2026-05-06T12:44:01.370779Z","end":"2026-05-06T12:44:01.475767Z","steps":["trace[2088700149] 'process raft request' (duration: 104.758324ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:44:01.919023Z","caller":"traceutil/trace.go:171","msg":"trace[945098299] transaction","detail":"{read_only:false; response_revision:2716; number_of_response:1; }","duration":"137.557599ms","start":"2026-05-06T12:44:01.781415Z","end":"2026-05-06T12:44:01.918973Z","steps":["trace[945098299] 'process raft request' (duration: 137.186248ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:47:40.211021Z","caller":"traceutil/trace.go:171","msg":"trace[984378422] transaction","detail":"{read_only:false; response_revision:4509; number_of_response:1; }","duration":"132.115526ms","start":"2026-05-06T12:47:40.078882Z","end":"2026-05-06T12:47:40.210998Z","steps":["trace[984378422] 'process raft request' (duration: 68.180909ms)","trace[984378422] 'compare' (duration: 63.63697ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:47:47.459045Z","caller":"traceutil/trace.go:171","msg":"trace[998714384] transaction","detail":"{read_only:false; response_revision:4687; number_of_response:1; }","duration":"103.677583ms","start":"2026-05-06T12:47:47.355336Z","end":"2026-05-06T12:47:47.459013Z","steps":["trace[998714384] 'process raft request' (duration: 84.436736ms)","trace[998714384] 'compare' (duration: 19.100964ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:47:47.478849Z","caller":"traceutil/trace.go:171","msg":"trace[1940335341] transaction","detail":"{read_only:false; response_revision:4688; number_of_response:1; }","duration":"115.624687ms","start":"2026-05-06T12:47:47.363208Z","end":"2026-05-06T12:47:47.478832Z","steps":["trace[1940335341] 'process raft request' (duration: 115.438963ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:47:47.615934Z","caller":"traceutil/trace.go:171","msg":"trace[7774963] transaction","detail":"{read_only:false; response_revision:4694; number_of_response:1; }","duration":"101.499892ms","start":"2026-05-06T12:47:47.514385Z","end":"2026-05-06T12:47:47.615885Z","steps":["trace[7774963] 'process raft request' (duration: 44.667551ms)","trace[7774963] 'get key's previous created_revision and leaseID' {req_type:put; key:/registry/leases/kube-system/plndr-svcs-lock; req_size:420; } (duration: 56.542124ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T12:48:09.168951Z","caller":"traceutil/trace.go:171","msg":"trace[1530516599] transaction","detail":"{read_only:false; response_revision:4908; number_of_response:1; }","duration":"280.470421ms","start":"2026-05-06T12:48:08.888442Z","end":"2026-05-06T12:48:09.168912Z","steps":["trace[1530516599] 'process raft request' (duration: 275.380776ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T12:49:37.694411Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2907} {"level":"info","ts":"2026-05-06T12:49:37.769283Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2907,"took":"72.705307ms","hash":1721907541,"current-db-size-bytes":53055488,"current-db-size":"53 MB","current-db-size-in-use-bytes":29478912,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-05-06T12:49:37.769364Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1721907541,"revision":2907,"compact-revision":-1} {"level":"info","ts":"2026-05-06T12:54:37.702585Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5645} {"level":"info","ts":"2026-05-06T12:54:37.793049Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5645,"took":"88.01921ms","hash":2347439524,"current-db-size-bytes":53055488,"current-db-size":"53 MB","current-db-size-in-use-bytes":18309120,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-05-06T12:54:37.79313Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2347439524,"revision":5645,"compact-revision":2907}