{"level":"warn","ts":"2026-04-14T13:54:22.999884Z","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-14T13:54:22.999988Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.146: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.146:2380","--initial-cluster=instance=https://199.19.213.146:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.146:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.146: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-14T13:54:23.000064Z","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-14T13:54:23.000078Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.146:2380"]} {"level":"info","ts":"2026-04-14T13:54:23.000103Z","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-14T13:54:23.000821Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.146:2379"]} {"level":"info","ts":"2026-04-14T13:54:23.00094Z","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.146:2380"],"listen-peer-urls":["https://199.19.213.146:2380"],"advertise-client-urls":["https://199.19.213.146:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.146:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.146: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-14T13:54:23.004527Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.354537ms"} {"level":"info","ts":"2026-04-14T13:54:23.009446Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"c8e9c1aa9bb537b7","cluster-id":"933c0a8774274c15"} {"level":"info","ts":"2026-04-14T13:54:23.00952Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 switched to configuration voters=()"} {"level":"info","ts":"2026-04-14T13:54:23.009544Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 became follower at term 0"} {"level":"info","ts":"2026-04-14T13:54:23.009559Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft c8e9c1aa9bb537b7 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-14T13:54:23.009567Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 became follower at term 1"} {"level":"info","ts":"2026-04-14T13:54:23.009609Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 switched to configuration voters=(14477315415660115895)"} {"level":"warn","ts":"2026-04-14T13:54:23.015448Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-14T13:54:23.016639Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-14T13:54:23.018471Z","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-14T13:54:23.020006Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"c8e9c1aa9bb537b7","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-14T13:54:23.020303Z","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-14T13:54:23.023161Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"c8e9c1aa9bb537b7","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-14T13:54:23.020424Z","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-14T13:54:23.023233Z","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-14T13:54:23.024388Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 switched to configuration voters=(14477315415660115895)"} {"level":"info","ts":"2026-04-14T13:54:23.025858Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"933c0a8774274c15","local-member-id":"c8e9c1aa9bb537b7","added-peer-id":"c8e9c1aa9bb537b7","added-peer-peer-urls":["https://199.19.213.146:2380"]} {"level":"info","ts":"2026-04-14T13:54:23.028159Z","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-14T13:54:23.028256Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.146:2380"} {"level":"info","ts":"2026-04-14T13:54:23.02829Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.146:2380"} {"level":"info","ts":"2026-04-14T13:54:23.028466Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"c8e9c1aa9bb537b7","initial-advertise-peer-urls":["https://199.19.213.146:2380"],"listen-peer-urls":["https://199.19.213.146:2380"],"advertise-client-urls":["https://199.19.213.146:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.146:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-14T13:54:23.028528Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-14T13:54:23.909909Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 is starting a new election at term 1"} {"level":"info","ts":"2026-04-14T13:54:23.909981Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-14T13:54:23.910007Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 received MsgPreVoteResp from c8e9c1aa9bb537b7 at term 1"} {"level":"info","ts":"2026-04-14T13:54:23.910053Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 became candidate at term 2"} {"level":"info","ts":"2026-04-14T13:54:23.910067Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 received MsgVoteResp from c8e9c1aa9bb537b7 at term 2"} {"level":"info","ts":"2026-04-14T13:54:23.910085Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c8e9c1aa9bb537b7 became leader at term 2"} {"level":"info","ts":"2026-04-14T13:54:23.910099Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: c8e9c1aa9bb537b7 elected leader c8e9c1aa9bb537b7 at term 2"} {"level":"info","ts":"2026-04-14T13:54:23.910938Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T13:54:23.911656Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"c8e9c1aa9bb537b7","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.146:2379]}","request-path":"/0/members/c8e9c1aa9bb537b7/attributes","cluster-id":"933c0a8774274c15","publish-timeout":"7s"} {"level":"info","ts":"2026-04-14T13:54:23.911806Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T13:54:23.912079Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"933c0a8774274c15","local-member-id":"c8e9c1aa9bb537b7","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T13:54:23.911996Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T13:54:23.912224Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T13:54:23.912267Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T13:54:23.912099Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-14T13:54:23.912296Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-14T13:54:23.916482Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-14T13:54:23.917365Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.146:2379"} {"level":"info","ts":"2026-04-14T13:54:53.325185Z","caller":"traceutil/trace.go:171","msg":"trace[1973179223] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"131.814931ms","start":"2026-04-14T13:54:53.192851Z","end":"2026-04-14T13:54:53.324666Z","steps":["trace[1973179223] 'process raft request' (duration: 131.617275ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343093Z","caller":"traceutil/trace.go:171","msg":"trace[18593606] transaction","detail":"{read_only:false; response_revision:513; number_of_response:1; }","duration":"147.055158ms","start":"2026-04-14T13:54:53.196016Z","end":"2026-04-14T13:54:53.343071Z","steps":["trace[18593606] 'process raft request' (duration: 146.808631ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343572Z","caller":"traceutil/trace.go:171","msg":"trace[637809971] transaction","detail":"{read_only:false; response_revision:517; number_of_response:1; }","duration":"134.796456ms","start":"2026-04-14T13:54:53.208735Z","end":"2026-04-14T13:54:53.343532Z","steps":["trace[637809971] 'process raft request' (duration: 134.356382ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343288Z","caller":"traceutil/trace.go:171","msg":"trace[1275123561] transaction","detail":"{read_only:false; response_revision:516; number_of_response:1; }","duration":"140.872755ms","start":"2026-04-14T13:54:53.202396Z","end":"2026-04-14T13:54:53.343269Z","steps":["trace[1275123561] 'process raft request' (duration: 140.647619ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.34333Z","caller":"traceutil/trace.go:171","msg":"trace[1512647251] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"147.232523ms","start":"2026-04-14T13:54:53.196088Z","end":"2026-04-14T13:54:53.343321Z","steps":["trace[1512647251] 'process raft request' (duration: 146.876003ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.34336Z","caller":"traceutil/trace.go:171","msg":"trace[933269997] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"142.428278ms","start":"2026-04-14T13:54:53.200922Z","end":"2026-04-14T13:54:53.34335Z","steps":["trace[933269997] 'process raft request' (duration: 142.084659ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343493Z","caller":"traceutil/trace.go:171","msg":"trace[1894949657] transaction","detail":"{read_only:false; response_revision:522; number_of_response:1; }","duration":"107.070188ms","start":"2026-04-14T13:54:53.236398Z","end":"2026-04-14T13:54:53.343469Z","steps":["trace[1894949657] 'process raft request' (duration: 107.022786ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343551Z","caller":"traceutil/trace.go:171","msg":"trace[342420958] transaction","detail":"{read_only:false; response_revision:520; number_of_response:1; }","duration":"124.851167ms","start":"2026-04-14T13:54:53.218693Z","end":"2026-04-14T13:54:53.343545Z","steps":["trace[342420958] 'process raft request' (duration: 124.506716ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343525Z","caller":"traceutil/trace.go:171","msg":"trace[1733096578] transaction","detail":"{read_only:false; response_revision:519; number_of_response:1; }","duration":"130.460775ms","start":"2026-04-14T13:54:53.213036Z","end":"2026-04-14T13:54:53.343496Z","steps":["trace[1733096578] 'process raft request' (duration: 130.119274ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.34357Z","caller":"traceutil/trace.go:171","msg":"trace[940215053] transaction","detail":"{read_only:false; response_revision:521; number_of_response:1; }","duration":"124.800615ms","start":"2026-04-14T13:54:53.218764Z","end":"2026-04-14T13:54:53.343565Z","steps":["trace[940215053] 'process raft request' (duration: 124.600369ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:53.343596Z","caller":"traceutil/trace.go:171","msg":"trace[1523488193] transaction","detail":"{read_only:false; response_revision:518; number_of_response:1; }","duration":"134.080235ms","start":"2026-04-14T13:54:53.209504Z","end":"2026-04-14T13:54:53.343585Z","steps":["trace[1523488193] 'process raft request' (duration: 133.619541ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:59.701416Z","caller":"traceutil/trace.go:171","msg":"trace[1463547957] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"110.027014ms","start":"2026-04-14T13:54:59.590192Z","end":"2026-04-14T13:54:59.700219Z","steps":["trace[1463547957] 'process raft request' (duration: 108.999596ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:54:59.891335Z","caller":"traceutil/trace.go:171","msg":"trace[358644327] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"125.639222ms","start":"2026-04-14T13:54:59.765666Z","end":"2026-04-14T13:54:59.891305Z","steps":["trace[358644327] 'process raft request' (duration: 90.185813ms)","trace[358644327] 'compare' (duration: 35.236323ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T13:55:00.422642Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"426.164687ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T13:55:00.422949Z","caller":"traceutil/trace.go:171","msg":"trace[1071158697] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"516.70812ms","start":"2026-04-14T13:54:59.906221Z","end":"2026-04-14T13:55:00.422929Z","steps":["trace[1071158697] 'process raft request' (duration: 89.560257ms)","trace[1071158697] 'compare' (duration: 426.017083ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T13:55:00.423125Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T13:54:59.906171Z","time spent":"516.859504ms","remote":"127.0.0.1:40090","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T13:55:00.445051Z","caller":"traceutil/trace.go:171","msg":"trace[2006530158] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"109.065836ms","start":"2026-04-14T13:55:00.335888Z","end":"2026-04-14T13:55:00.444954Z","steps":["trace[2006530158] 'process raft request' (duration: 108.398998ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T13:55:15.25213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.255804ms","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-04-14T13:55:15.252201Z","caller":"traceutil/trace.go:171","msg":"trace[1451914306] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:784; }","duration":"190.418208ms","start":"2026-04-14T13:55:15.061768Z","end":"2026-04-14T13:55:15.252186Z","steps":["trace[1451914306] 'range keys from in-memory index tree' (duration: 190.07873ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T13:55:15.252263Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.980121ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-lxnc6\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-04-14T13:55:15.25235Z","caller":"traceutil/trace.go:171","msg":"trace[110592617] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-lxnc6; range_end:; response_count:1; response_revision:784; }","duration":"273.154375ms","start":"2026-04-14T13:55:14.979177Z","end":"2026-04-14T13:55:15.252332Z","steps":["trace[110592617] 'range keys from in-memory index tree' (duration: 272.771617ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:55:44.470928Z","caller":"traceutil/trace.go:171","msg":"trace[455034776] transaction","detail":"{read_only:false; response_revision:1182; number_of_response:1; }","duration":"195.817642ms","start":"2026-04-14T13:55:44.275076Z","end":"2026-04-14T13:55:44.470894Z","steps":["trace[455034776] 'process raft request' (duration: 195.588188ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:56:08.444469Z","caller":"traceutil/trace.go:171","msg":"trace[1326985347] transaction","detail":"{read_only:false; response_revision:1459; number_of_response:1; }","duration":"118.534366ms","start":"2026-04-14T13:56:08.325891Z","end":"2026-04-14T13:56:08.444426Z","steps":["trace[1326985347] 'process raft request' (duration: 84.092159ms)","trace[1326985347] 'compare' (duration: 34.234684ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T13:56:33.592693Z","caller":"traceutil/trace.go:171","msg":"trace[1078389507] transaction","detail":"{read_only:false; response_revision:1869; number_of_response:1; }","duration":"174.123954ms","start":"2026-04-14T13:56:33.418533Z","end":"2026-04-14T13:56:33.592657Z","steps":["trace[1078389507] 'process raft request' (duration: 173.895162ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:12.983701Z","caller":"traceutil/trace.go:171","msg":"trace[1380515556] transaction","detail":"{read_only:false; response_revision:2134; number_of_response:1; }","duration":"184.373509ms","start":"2026-04-14T13:57:12.799282Z","end":"2026-04-14T13:57:12.983656Z","steps":["trace[1380515556] 'process raft request' (duration: 184.193138ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:13.022097Z","caller":"traceutil/trace.go:171","msg":"trace[1101827] linearizableReadLoop","detail":"{readStateIndex:2216; appliedIndex:2214; }","duration":"161.324753ms","start":"2026-04-14T13:57:12.860753Z","end":"2026-04-14T13:57:13.022078Z","steps":["trace[1101827] 'read index received' (duration: 122.678357ms)","trace[1101827] 'applied index is now lower than readState.Index' (duration: 38.645146ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T13:57:13.022279Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.541064ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T13:57:13.022324Z","caller":"traceutil/trace.go:171","msg":"trace[172020399] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2135; }","duration":"161.609355ms","start":"2026-04-14T13:57:12.860701Z","end":"2026-04-14T13:57:13.02231Z","steps":["trace[172020399] 'agreement among raft nodes before linearized reading' (duration: 161.450024ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:13.022278Z","caller":"traceutil/trace.go:171","msg":"trace[1510100927] transaction","detail":"{read_only:false; response_revision:2135; number_of_response:1; }","duration":"215.451277ms","start":"2026-04-14T13:57:12.806756Z","end":"2026-04-14T13:57:13.022207Z","steps":["trace[1510100927] 'process raft request' (duration: 208.667117ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:14.297317Z","caller":"traceutil/trace.go:171","msg":"trace[1260974919] linearizableReadLoop","detail":"{readStateIndex:2220; appliedIndex:2219; }","duration":"106.592505ms","start":"2026-04-14T13:57:14.190693Z","end":"2026-04-14T13:57:14.297286Z","steps":["trace[1260974919] 'read index received' (duration: 106.380513ms)","trace[1260974919] 'applied index is now lower than readState.Index' (duration: 210.682µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T13:57:14.297609Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.888918ms","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-04-14T13:57:14.297649Z","caller":"traceutil/trace.go:171","msg":"trace[766457660] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2139; }","duration":"106.993799ms","start":"2026-04-14T13:57:14.190641Z","end":"2026-04-14T13:57:14.297635Z","steps":["trace[766457660] 'agreement among raft nodes before linearized reading' (duration: 106.765756ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:14.297786Z","caller":"traceutil/trace.go:171","msg":"trace[889790589] transaction","detail":"{read_only:false; response_revision:2139; number_of_response:1; }","duration":"290.079162ms","start":"2026-04-14T13:57:14.00753Z","end":"2026-04-14T13:57:14.297609Z","steps":["trace[889790589] 'process raft request' (duration: 289.552517ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T13:57:14.498401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.24089ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T13:57:14.49868Z","caller":"traceutil/trace.go:171","msg":"trace[1339277552] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2139; }","duration":"156.589113ms","start":"2026-04-14T13:57:14.342071Z","end":"2026-04-14T13:57:14.49866Z","steps":["trace[1339277552] 'range keys from in-memory index tree' (duration: 156.005297ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T13:57:14.721889Z","caller":"traceutil/trace.go:171","msg":"trace[2016525372] transaction","detail":"{read_only:false; response_revision:2142; number_of_response:1; }","duration":"117.192471ms","start":"2026-04-14T13:57:14.604653Z","end":"2026-04-14T13:57:14.721846Z","steps":["trace[2016525372] 'process raft request' (duration: 18.922082ms)","trace[2016525372] 'compare' (duration: 98.099428ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T14:02:16.225929Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.149841ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/storageclasses/general\" ","response":"range_response_count:1 size:1124"} {"level":"info","ts":"2026-04-14T14:02:16.226029Z","caller":"traceutil/trace.go:171","msg":"trace[560820980] range","detail":"{range_begin:/registry/storageclasses/general; range_end:; response_count:1; response_revision:4399; }","duration":"114.306123ms","start":"2026-04-14T14:02:16.111701Z","end":"2026-04-14T14:02:16.226007Z","steps":["trace[560820980] 'range keys from in-memory index tree' (duration: 113.953327ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:16.225999Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.702343ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager\" ","response":"range_response_count:1 size:2643"} {"level":"info","ts":"2026-04-14T14:02:16.226116Z","caller":"traceutil/trace.go:171","msg":"trace[1378517388] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager; range_end:; response_count:1; response_revision:4399; }","duration":"113.869816ms","start":"2026-04-14T14:02:16.112217Z","end":"2026-04-14T14:02:16.226087Z","steps":["trace[1378517388] 'range keys from in-memory index tree' (duration: 113.46518ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:16.226356Z","caller":"traceutil/trace.go:171","msg":"trace[1759438162] transaction","detail":"{read_only:false; response_revision:4400; number_of_response:1; }","duration":"107.878726ms","start":"2026-04-14T14:02:16.118347Z","end":"2026-04-14T14:02:16.226225Z","steps":["trace[1759438162] 'process raft request' (duration: 107.680333ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:16.232301Z","caller":"traceutil/trace.go:171","msg":"trace[1136757345] transaction","detail":"{read_only:false; response_revision:4401; number_of_response:1; }","duration":"106.648448ms","start":"2026-04-14T14:02:16.125635Z","end":"2026-04-14T14:02:16.232283Z","steps":["trace[1136757345] 'process raft request' (duration: 106.08098ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:27.78653Z","caller":"traceutil/trace.go:171","msg":"trace[1366780516] transaction","detail":"{read_only:false; response_revision:4691; number_of_response:1; }","duration":"206.694119ms","start":"2026-04-14T14:02:27.5798Z","end":"2026-04-14T14:02:27.786494Z","steps":["trace[1366780516] 'process raft request' (duration: 155.089498ms)","trace[1366780516] 'compare' (duration: 51.348927ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T14:02:27.78667Z","caller":"traceutil/trace.go:171","msg":"trace[692177348] transaction","detail":"{read_only:false; response_revision:4692; number_of_response:1; }","duration":"206.80749ms","start":"2026-04-14T14:02:27.579815Z","end":"2026-04-14T14:02:27.786623Z","steps":["trace[692177348] 'process raft request' (duration: 206.579147ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:27.786793Z","caller":"traceutil/trace.go:171","msg":"trace[57312669] transaction","detail":"{read_only:false; response_revision:4693; number_of_response:1; }","duration":"205.46109ms","start":"2026-04-14T14:02:27.581166Z","end":"2026-04-14T14:02:27.786627Z","steps":["trace[57312669] 'process raft request' (duration: 205.287327ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:40.816546Z","caller":"traceutil/trace.go:171","msg":"trace[546441464] transaction","detail":"{read_only:false; response_revision:4860; number_of_response:1; }","duration":"510.132406ms","start":"2026-04-14T14:02:40.30639Z","end":"2026-04-14T14:02:40.816523Z","steps":["trace[546441464] 'process raft request' (duration: 446.204579ms)","trace[546441464] 'compare' (duration: 63.314258ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T14:02:40.816658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.306365Z","time spent":"510.233758ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T14:02:40.881417Z","caller":"traceutil/trace.go:171","msg":"trace[412736328] transaction","detail":"{read_only:false; response_revision:4861; number_of_response:1; }","duration":"566.268262ms","start":"2026-04-14T14:02:40.315129Z","end":"2026-04-14T14:02:40.881397Z","steps":["trace[412736328] 'process raft request' (duration: 566.09699ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:40.881569Z","caller":"traceutil/trace.go:171","msg":"trace[1367156143] transaction","detail":"{read_only:false; response_revision:4862; number_of_response:1; }","duration":"565.242237ms","start":"2026-04-14T14:02:40.316312Z","end":"2026-04-14T14:02:40.881554Z","steps":["trace[1367156143] 'process raft request' (duration: 565.035494ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:40.881646Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.316293Z","time spent":"565.305858ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T14:02:40.88177Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"520.23073ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-04-14T14:02:40.881579Z","caller":"traceutil/trace.go:171","msg":"trace[1836520567] linearizableReadLoop","detail":"{readStateIndex:5046; appliedIndex:5043; }","duration":"520.005896ms","start":"2026-04-14T14:02:40.361531Z","end":"2026-04-14T14:02:40.881537Z","steps":["trace[1836520567] 'read index received' (duration: 391.060087ms)","trace[1836520567] 'applied index is now lower than readState.Index' (duration: 128.943949ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T14:02:40.881835Z","caller":"traceutil/trace.go:171","msg":"trace[1795091004] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4862; }","duration":"520.334821ms","start":"2026-04-14T14:02:40.361483Z","end":"2026-04-14T14:02:40.881818Z","steps":["trace[1795091004] 'agreement among raft nodes before linearized reading' (duration: 520.172959ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:40.881872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.361468Z","time spent":"520.395832ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-04-14T14:02:40.881965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.76801ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-04-14T14:02:40.881994Z","caller":"traceutil/trace.go:171","msg":"trace[554770934] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4862; }","duration":"253.830171ms","start":"2026-04-14T14:02:40.628156Z","end":"2026-04-14T14:02:40.881986Z","steps":["trace[554770934] 'agreement among raft nodes before linearized reading' (duration: 253.71891ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:40.882017Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"510.184867ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"warn","ts":"2026-04-14T14:02:40.882023Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.012104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:10392"} {"level":"info","ts":"2026-04-14T14:02:40.882046Z","caller":"traceutil/trace.go:171","msg":"trace[15339870] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4862; }","duration":"510.261518ms","start":"2026-04-14T14:02:40.371775Z","end":"2026-04-14T14:02:40.882037Z","steps":["trace[15339870] 'agreement among raft nodes before linearized reading' (duration: 510.097516ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T14:02:40.88205Z","caller":"traceutil/trace.go:171","msg":"trace[1005863732] range","detail":"{range_begin:/registry/pods/openstack/rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:4862; }","duration":"340.078525ms","start":"2026-04-14T14:02:40.541963Z","end":"2026-04-14T14:02:40.882042Z","steps":["trace[1005863732] 'agreement among raft nodes before linearized reading' (duration: 340.004244ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:40.882037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.015255ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1865"} {"level":"warn","ts":"2026-04-14T14:02:40.882075Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.541942Z","time spent":"340.127295ms","remote":"127.0.0.1:40090","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":1,"response size":10416,"request content":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" "} {"level":"warn","ts":"2026-04-14T14:02:40.882076Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.371761Z","time spent":"510.308498ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":517,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-04-14T14:02:40.882088Z","caller":"traceutil/trace.go:171","msg":"trace[911206143] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:4862; }","duration":"278.098275ms","start":"2026-04-14T14:02:40.603974Z","end":"2026-04-14T14:02:40.882072Z","steps":["trace[911206143] 'agreement among raft nodes before linearized reading' (duration: 277.965204ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T14:02:40.88231Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T14:02:40.3151Z","time spent":"566.386044ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T14:04:23.940407Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2947} {"level":"info","ts":"2026-04-14T14:04:24.031737Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2947,"took":"89.506289ms","hash":1348296255,"current-db-size-bytes":54198272,"current-db-size":"54 MB","current-db-size-in-use-bytes":29388800,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-04-14T14:04:24.031797Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1348296255,"revision":2947,"compact-revision":-1} {"level":"info","ts":"2026-04-14T14:09:23.946815Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5665} {"level":"info","ts":"2026-04-14T14:09:24.039483Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5665,"took":"91.385722ms","hash":1036392015,"current-db-size-bytes":54198272,"current-db-size":"54 MB","current-db-size-in-use-bytes":18227200,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-04-14T14:09:24.039691Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1036392015,"revision":5665,"compact-revision":2947}