{"level":"warn","ts":"2026-05-18T03:38:42.60992Z","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-18T03:38:42.610028Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.22: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.22:2380","--initial-cluster=instance=https://199.204.45.22:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.22:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.22: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-18T03:38:42.610107Z","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-18T03:38:42.61012Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.22:2380"]} {"level":"info","ts":"2026-05-18T03:38:42.610138Z","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-18T03:38:42.610852Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.22:2379"]} {"level":"info","ts":"2026-05-18T03:38:42.610944Z","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.22:2380"],"listen-peer-urls":["https://199.204.45.22:2380"],"advertise-client-urls":["https://199.204.45.22:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.22:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.22: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-18T03:38:42.620702Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"9.531334ms"} {"level":"info","ts":"2026-05-18T03:38:42.64197Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"fed19d9291630e09","cluster-id":"6ebf1e01320cc017"} {"level":"info","ts":"2026-05-18T03:38:42.642045Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 switched to configuration voters=()"} {"level":"info","ts":"2026-05-18T03:38:42.642064Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 became follower at term 0"} {"level":"info","ts":"2026-05-18T03:38:42.642072Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft fed19d9291630e09 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-18T03:38:42.642082Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 became follower at term 1"} {"level":"info","ts":"2026-05-18T03:38:42.642114Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 switched to configuration voters=(18361630408596196873)"} {"level":"warn","ts":"2026-05-18T03:38:42.654172Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-18T03:38:42.655584Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-18T03:38:42.656658Z","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-18T03:38:42.658783Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"fed19d9291630e09","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-18T03:38:42.658909Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"fed19d9291630e09","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-18T03:38:42.659037Z","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-18T03:38:42.659959Z","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-18T03:38:42.660002Z","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-18T03:38:42.661405Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 switched to configuration voters=(18361630408596196873)"} {"level":"info","ts":"2026-05-18T03:38:42.665361Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"6ebf1e01320cc017","local-member-id":"fed19d9291630e09","added-peer-id":"fed19d9291630e09","added-peer-peer-urls":["https://199.204.45.22:2380"]} {"level":"info","ts":"2026-05-18T03:38:42.666312Z","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-18T03:38:42.666435Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.22:2380"} {"level":"info","ts":"2026-05-18T03:38:42.666482Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.22:2380"} {"level":"info","ts":"2026-05-18T03:38:42.666541Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"fed19d9291630e09","initial-advertise-peer-urls":["https://199.204.45.22:2380"],"listen-peer-urls":["https://199.204.45.22:2380"],"advertise-client-urls":["https://199.204.45.22:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.22:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-18T03:38:42.666565Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-18T03:38:42.942264Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 is starting a new election at term 1"} {"level":"info","ts":"2026-05-18T03:38:42.942338Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 became pre-candidate at term 1"} {"level":"info","ts":"2026-05-18T03:38:42.942365Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 received MsgPreVoteResp from fed19d9291630e09 at term 1"} {"level":"info","ts":"2026-05-18T03:38:42.942379Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 became candidate at term 2"} {"level":"info","ts":"2026-05-18T03:38:42.942387Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 received MsgVoteResp from fed19d9291630e09 at term 2"} {"level":"info","ts":"2026-05-18T03:38:42.942399Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fed19d9291630e09 became leader at term 2"} {"level":"info","ts":"2026-05-18T03:38:42.942434Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: fed19d9291630e09 elected leader fed19d9291630e09 at term 2"} {"level":"info","ts":"2026-05-18T03:38:42.946771Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-18T03:38:42.95813Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"fed19d9291630e09","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.22:2379]}","request-path":"/0/members/fed19d9291630e09/attributes","cluster-id":"6ebf1e01320cc017","publish-timeout":"7s"} {"level":"info","ts":"2026-05-18T03:38:42.958143Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-18T03:38:42.959253Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-18T03:38:42.959668Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-18T03:38:42.959758Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-18T03:38:42.962665Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-18T03:38:42.963134Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.22:2379"} {"level":"info","ts":"2026-05-18T03:38:42.965858Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"6ebf1e01320cc017","local-member-id":"fed19d9291630e09","cluster-version":"3.5"} {"level":"info","ts":"2026-05-18T03:38:42.966018Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-18T03:38:42.966102Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-18T03:39:17.977998Z","caller":"traceutil/trace.go:171","msg":"trace[271919334] transaction","detail":"{read_only:false; response_revision:577; number_of_response:1; }","duration":"182.866765ms","start":"2026-05-18T03:39:17.795103Z","end":"2026-05-18T03:39:17.97797Z","steps":["trace[271919334] 'process raft request' (duration: 129.159129ms)","trace[271919334] 'compare' (duration: 53.632734ms)"],"step_count":2} {"level":"info","ts":"2026-05-18T03:39:18.589414Z","caller":"traceutil/trace.go:171","msg":"trace[1248828174] transaction","detail":"{read_only:false; response_revision:579; number_of_response:1; }","duration":"435.26197ms","start":"2026-05-18T03:39:18.154114Z","end":"2026-05-18T03:39:18.589376Z","steps":["trace[1248828174] 'process raft request' (duration: 433.260552ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:18.590085Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:39:18.154091Z","time spent":"435.488356ms","remote":"127.0.0.1:36602","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036305,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-18T03:39:19.249153Z","caller":"traceutil/trace.go:171","msg":"trace[1074116324] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"594.891651ms","start":"2026-05-18T03:39:18.654227Z","end":"2026-05-18T03:39:19.249119Z","steps":["trace[1074116324] 'process raft request' (duration: 583.35431ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:39:19.249208Z","caller":"traceutil/trace.go:171","msg":"trace[2063049306] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"304.895981ms","start":"2026-05-18T03:39:18.944279Z","end":"2026-05-18T03:39:19.249175Z","steps":["trace[2063049306] 'process raft request' (duration: 304.790418ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:39:19.249274Z","caller":"traceutil/trace.go:171","msg":"trace[346427466] linearizableReadLoop","detail":"{readStateIndex:602; appliedIndex:601; }","duration":"338.93899ms","start":"2026-05-18T03:39:18.910309Z","end":"2026-05-18T03:39:19.249248Z","steps":["trace[346427466] 'read index received' (duration: 327.364739ms)","trace[346427466] 'applied index is now lower than readState.Index' (duration: 11.572021ms)"],"step_count":2} {"level":"warn","ts":"2026-05-18T03:39:19.249366Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:39:18.944252Z","time spent":"305.033805ms","remote":"127.0.0.1:36672","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4538,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-18T03:39:19.249407Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:39:18.654207Z","time spent":"595.037885ms","remote":"127.0.0.1:36728","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-18T03:39:19.249572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"339.251847ms","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-18T03:39:19.249683Z","caller":"traceutil/trace.go:171","msg":"trace[1809120483] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:582; }","duration":"339.36871ms","start":"2026-05-18T03:39:18.910297Z","end":"2026-05-18T03:39:19.249666Z","steps":["trace[1809120483] 'agreement among raft nodes before linearized reading' (duration: 339.096053ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:19.24973Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:39:18.910241Z","time spent":"339.475502ms","remote":"127.0.0.1:36768","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-05-18T03:39:19.249783Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.593848ms","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-18T03:39:19.249847Z","caller":"traceutil/trace.go:171","msg":"trace[253285279] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:582; }","duration":"140.67999ms","start":"2026-05-18T03:39:19.109154Z","end":"2026-05-18T03:39:19.249834Z","steps":["trace[253285279] 'agreement among raft nodes before linearized reading' (duration: 140.497106ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:19.249577Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.328339ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-18T03:39:19.249902Z","caller":"traceutil/trace.go:171","msg":"trace[1438926778] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:582; }","duration":"172.706758ms","start":"2026-05-18T03:39:19.077178Z","end":"2026-05-18T03:39:19.249884Z","steps":["trace[1438926778] 'agreement among raft nodes before linearized reading' (duration: 172.344499ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:19.249987Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.012311ms","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-18T03:39:19.250038Z","caller":"traceutil/trace.go:171","msg":"trace[1688039195] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:582; }","duration":"144.093293ms","start":"2026-05-18T03:39:19.10593Z","end":"2026-05-18T03:39:19.250023Z","steps":["trace[1688039195] 'agreement among raft nodes before linearized reading' (duration: 143.947179ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:39:34.327949Z","caller":"traceutil/trace.go:171","msg":"trace[161342007] linearizableReadLoop","detail":"{readStateIndex:765; appliedIndex:764; }","duration":"247.140307ms","start":"2026-05-18T03:39:34.080785Z","end":"2026-05-18T03:39:34.327925Z","steps":["trace[161342007] 'read index received' (duration: 246.972373ms)","trace[161342007] 'applied index is now lower than readState.Index' (duration: 166.914µs)"],"step_count":2} {"level":"info","ts":"2026-05-18T03:39:34.328048Z","caller":"traceutil/trace.go:171","msg":"trace[2077800168] transaction","detail":"{read_only:false; response_revision:740; number_of_response:1; }","duration":"274.470512ms","start":"2026-05-18T03:39:34.053553Z","end":"2026-05-18T03:39:34.328024Z","steps":["trace[2077800168] 'process raft request' (duration: 274.206755ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:34.328222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.375902ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-6r6gw\" ","response":"range_response_count:1 size:3964"} {"level":"info","ts":"2026-05-18T03:39:34.328285Z","caller":"traceutil/trace.go:171","msg":"trace[296259717] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-6r6gw; range_end:; response_count:1; response_revision:740; }","duration":"191.484685ms","start":"2026-05-18T03:39:34.136787Z","end":"2026-05-18T03:39:34.328272Z","steps":["trace[296259717] 'agreement among raft nodes before linearized reading' (duration: 191.30001ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:39:34.328167Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"247.348462ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-18T03:39:34.328816Z","caller":"traceutil/trace.go:171","msg":"trace[128072717] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:740; }","duration":"248.036879ms","start":"2026-05-18T03:39:34.080738Z","end":"2026-05-18T03:39:34.328775Z","steps":["trace[128072717] 'agreement among raft nodes before linearized reading' (duration: 247.326902ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:09.480328Z","caller":"traceutil/trace.go:171","msg":"trace[1613304063] transaction","detail":"{read_only:false; response_revision:953; number_of_response:1; }","duration":"100.646607ms","start":"2026-05-18T03:40:09.379648Z","end":"2026-05-18T03:40:09.480294Z","steps":["trace[1613304063] 'process raft request' (duration: 100.432512ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:31.716459Z","caller":"traceutil/trace.go:171","msg":"trace[1748752347] transaction","detail":"{read_only:false; response_revision:1026; number_of_response:1; }","duration":"159.241456ms","start":"2026-05-18T03:40:31.557175Z","end":"2026-05-18T03:40:31.716416Z","steps":["trace[1748752347] 'process raft request' (duration: 158.914598ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:31.921517Z","caller":"traceutil/trace.go:171","msg":"trace[1317075982] linearizableReadLoop","detail":"{readStateIndex:1066; appliedIndex:1064; }","duration":"196.716612ms","start":"2026-05-18T03:40:31.724775Z","end":"2026-05-18T03:40:31.921491Z","steps":["trace[1317075982] 'read index received' (duration: 167.858013ms)","trace[1317075982] 'applied index is now lower than readState.Index' (duration: 28.857489ms)"],"step_count":2} {"level":"info","ts":"2026-05-18T03:40:31.921536Z","caller":"traceutil/trace.go:171","msg":"trace[1995194124] transaction","detail":"{read_only:false; response_revision:1027; number_of_response:1; }","duration":"200.721179ms","start":"2026-05-18T03:40:31.720773Z","end":"2026-05-18T03:40:31.921494Z","steps":["trace[1995194124] 'process raft request' (duration: 171.908112ms)","trace[1995194124] 'compare' (duration: 28.613052ms)"],"step_count":2} {"level":"info","ts":"2026-05-18T03:40:31.921551Z","caller":"traceutil/trace.go:171","msg":"trace[710791724] transaction","detail":"{read_only:false; response_revision:1028; number_of_response:1; }","duration":"200.74126ms","start":"2026-05-18T03:40:31.720781Z","end":"2026-05-18T03:40:31.921522Z","steps":["trace[710791724] 'process raft request' (duration: 200.661268ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:31.921727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.928187ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-05-18T03:40:31.921763Z","caller":"traceutil/trace.go:171","msg":"trace[282382163] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1028; }","duration":"197.018299ms","start":"2026-05-18T03:40:31.724735Z","end":"2026-05-18T03:40:31.921753Z","steps":["trace[282382163] 'agreement among raft nodes before linearized reading' (duration: 196.855336ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:32.701404Z","caller":"traceutil/trace.go:171","msg":"trace[660261267] transaction","detail":"{read_only:false; response_revision:1030; number_of_response:1; }","duration":"108.402414ms","start":"2026-05-18T03:40:32.592975Z","end":"2026-05-18T03:40:32.701377Z","steps":["trace[660261267] 'process raft request' (duration: 108.24471ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:34.501157Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"563.362708ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-05-18T03:40:34.50122Z","caller":"traceutil/trace.go:171","msg":"trace[870289274] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1032; }","duration":"563.472311ms","start":"2026-05-18T03:40:33.937734Z","end":"2026-05-18T03:40:34.501206Z","steps":["trace[870289274] 'range keys from in-memory index tree' (duration: 563.196104ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:34.501243Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:40:33.937711Z","time spent":"563.526992ms","remote":"127.0.0.1:36768","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-05-18T03:40:34.501204Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"423.427201ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-18T03:40:34.501313Z","caller":"traceutil/trace.go:171","msg":"trace[348163478] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1032; }","duration":"423.597535ms","start":"2026-05-18T03:40:34.077691Z","end":"2026-05-18T03:40:34.501289Z","steps":["trace[348163478] 'range keys from in-memory index tree' (duration: 423.303638ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:34.501368Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:40:34.077664Z","time spent":"423.694728ms","remote":"127.0.0.1:36510","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-05-18T03:40:34.501398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"575.836331ms","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-18T03:40:34.501416Z","caller":"traceutil/trace.go:171","msg":"trace[1667973394] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1032; }","duration":"575.888012ms","start":"2026-05-18T03:40:33.925523Z","end":"2026-05-18T03:40:34.501411Z","steps":["trace[1667973394] 'range keys from in-memory index tree' (duration: 575.726308ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:34.50143Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:40:33.925506Z","time spent":"575.921152ms","remote":"127.0.0.1:36768","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-05-18T03:40:34.501497Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"575.947363ms","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-18T03:40:34.501514Z","caller":"traceutil/trace.go:171","msg":"trace[450037400] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1032; }","duration":"575.987654ms","start":"2026-05-18T03:40:33.925523Z","end":"2026-05-18T03:40:34.50151Z","steps":["trace[450037400] 'range keys from in-memory index tree' (duration: 575.82466ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:40:34.501526Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-18T03:40:33.925506Z","time spent":"576.017335ms","remote":"127.0.0.1:36768","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-05-18T03:40:34.628178Z","caller":"traceutil/trace.go:171","msg":"trace[199954689] transaction","detail":"{read_only:false; response_revision:1035; number_of_response:1; }","duration":"122.217469ms","start":"2026-05-18T03:40:34.505925Z","end":"2026-05-18T03:40:34.628142Z","steps":["trace[199954689] 'process raft request' (duration: 122.161828ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:34.628214Z","caller":"traceutil/trace.go:171","msg":"trace[226743298] transaction","detail":"{read_only:false; response_revision:1034; number_of_response:1; }","duration":"122.617929ms","start":"2026-05-18T03:40:34.505561Z","end":"2026-05-18T03:40:34.628179Z","steps":["trace[226743298] 'process raft request' (duration: 122.370663ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:40:48.13489Z","caller":"traceutil/trace.go:171","msg":"trace[921939152] transaction","detail":"{read_only:false; response_revision:1130; number_of_response:1; }","duration":"254.606843ms","start":"2026-05-18T03:40:47.880265Z","end":"2026-05-18T03:40:48.134872Z","steps":["trace[921939152] 'process raft request' (duration: 254.47928ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:41:03.359602Z","caller":"traceutil/trace.go:171","msg":"trace[1032535525] transaction","detail":"{read_only:false; response_revision:1201; number_of_response:1; }","duration":"159.084462ms","start":"2026-05-18T03:41:03.200486Z","end":"2026-05-18T03:41:03.35957Z","steps":["trace[1032535525] 'process raft request' (duration: 136.191047ms)","trace[1032535525] 'compare' (duration: 22.752731ms)"],"step_count":2} {"level":"info","ts":"2026-05-18T03:41:04.377119Z","caller":"traceutil/trace.go:171","msg":"trace[1512605720] transaction","detail":"{read_only:false; response_revision:1203; number_of_response:1; }","duration":"146.318813ms","start":"2026-05-18T03:41:04.230777Z","end":"2026-05-18T03:41:04.377095Z","steps":["trace[1512605720] 'process raft request' (duration: 146.166299ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:41:04.754334Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.541763ms","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-18T03:41:04.754406Z","caller":"traceutil/trace.go:171","msg":"trace[504874384] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1204; }","duration":"254.648294ms","start":"2026-05-18T03:41:04.499738Z","end":"2026-05-18T03:41:04.754387Z","steps":["trace[504874384] 'range keys from in-memory index tree' (duration: 254.46608ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:41:05.083782Z","caller":"traceutil/trace.go:171","msg":"trace[574236057] transaction","detail":"{read_only:false; response_revision:1213; number_of_response:1; }","duration":"168.339665ms","start":"2026-05-18T03:41:04.915414Z","end":"2026-05-18T03:41:05.083754Z","steps":["trace[574236057] 'process raft request' (duration: 161.802697ms)"],"step_count":1} {"level":"info","ts":"2026-05-18T03:41:05.462965Z","caller":"traceutil/trace.go:171","msg":"trace[228751138] transaction","detail":"{read_only:false; response_revision:1214; number_of_response:1; }","duration":"145.899212ms","start":"2026-05-18T03:41:05.317046Z","end":"2026-05-18T03:41:05.462946Z","steps":["trace[228751138] 'process raft request' (duration: 145.761089ms)"],"step_count":1} {"level":"warn","ts":"2026-05-18T03:41:18.186364Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.229006ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-18T03:41:18.186452Z","caller":"traceutil/trace.go:171","msg":"trace[722764575] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1298; }","duration":"108.366709ms","start":"2026-05-18T03:41:18.078069Z","end":"2026-05-18T03:41:18.186436Z","steps":["trace[722764575] 'range keys from in-memory index tree' (duration: 108.154694ms)"],"step_count":1}