{"level":"warn","ts":"2026-09-19T01:05:27.459817Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-09-19T01:05:27.459929Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.128: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://162.253.55.128:2380","--initial-cluster=instance=https://162.253.55.128:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.128:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.128: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-09-19T01:05:27.460009Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-09-19T01:05:27.46002Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.128:2380"]} {"level":"info","ts":"2026-09-19T01:05:27.460041Z","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-09-19T01:05:27.460719Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.128:2379"]} {"level":"info","ts":"2026-09-19T01:05:27.460795Z","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://162.253.55.128:2380"],"listen-peer-urls":["https://162.253.55.128:2380"],"advertise-client-urls":["https://162.253.55.128:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.128:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.128: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-09-19T01:05:27.465514Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.46405ms"} {"level":"info","ts":"2026-09-19T01:05:27.481417Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"e3e8b7bea2e3a32b","cluster-id":"ca619600f96ab468"} {"level":"info","ts":"2026-09-19T01:05:27.481529Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b switched to configuration voters=()"} {"level":"info","ts":"2026-09-19T01:05:27.481554Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b became follower at term 0"} {"level":"info","ts":"2026-09-19T01:05:27.481569Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft e3e8b7bea2e3a32b [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-09-19T01:05:27.48158Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b became follower at term 1"} {"level":"info","ts":"2026-09-19T01:05:27.481633Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b switched to configuration voters=(16422578070611010347)"} {"level":"warn","ts":"2026-09-19T01:05:27.494332Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-09-19T01:05:27.498515Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-09-19T01:05:27.500164Z","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-09-19T01:05:27.502248Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"e3e8b7bea2e3a32b","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-09-19T01:05:27.503402Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"e3e8b7bea2e3a32b","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-09-19T01:05:27.503477Z","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-09-19T01:05:27.507201Z","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-09-19T01:05:27.509778Z","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-09-19T01:05:27.510479Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b switched to configuration voters=(16422578070611010347)"} {"level":"info","ts":"2026-09-19T01:05:27.510566Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"ca619600f96ab468","local-member-id":"e3e8b7bea2e3a32b","added-peer-id":"e3e8b7bea2e3a32b","added-peer-peer-urls":["https://162.253.55.128:2380"]} {"level":"info","ts":"2026-09-19T01:05:27.511089Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.128:2380"} {"level":"info","ts":"2026-09-19T01:05:27.511102Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.128:2380"} {"level":"info","ts":"2026-09-19T01:05:27.51105Z","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-09-19T01:05:27.511392Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-09-19T01:05:27.51138Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"e3e8b7bea2e3a32b","initial-advertise-peer-urls":["https://162.253.55.128:2380"],"listen-peer-urls":["https://162.253.55.128:2380"],"advertise-client-urls":["https://162.253.55.128:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.128:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-09-19T01:05:28.482773Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b is starting a new election at term 1"} {"level":"info","ts":"2026-09-19T01:05:28.482845Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b became pre-candidate at term 1"} {"level":"info","ts":"2026-09-19T01:05:28.482898Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b received MsgPreVoteResp from e3e8b7bea2e3a32b at term 1"} {"level":"info","ts":"2026-09-19T01:05:28.482919Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b became candidate at term 2"} {"level":"info","ts":"2026-09-19T01:05:28.482931Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b received MsgVoteResp from e3e8b7bea2e3a32b at term 2"} {"level":"info","ts":"2026-09-19T01:05:28.482952Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3e8b7bea2e3a32b became leader at term 2"} {"level":"info","ts":"2026-09-19T01:05:28.482979Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: e3e8b7bea2e3a32b elected leader e3e8b7bea2e3a32b at term 2"} {"level":"info","ts":"2026-09-19T01:05:28.641647Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-09-19T01:05:28.749236Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"e3e8b7bea2e3a32b","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.128:2379]}","request-path":"/0/members/e3e8b7bea2e3a32b/attributes","cluster-id":"ca619600f96ab468","publish-timeout":"7s"} {"level":"info","ts":"2026-09-19T01:05:28.74927Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-09-19T01:05:28.749545Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-09-19T01:05:28.749608Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-09-19T01:05:28.74969Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-09-19T01:05:28.750729Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"ca619600f96ab468","local-member-id":"e3e8b7bea2e3a32b","cluster-version":"3.5"} {"level":"info","ts":"2026-09-19T01:05:28.750923Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-09-19T01:05:28.75098Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-09-19T01:05:28.753136Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-09-19T01:05:28.757781Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.128:2379"} {"level":"warn","ts":"2026-09-19T01:05:29.021293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"214.92426ms","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:4"} {"level":"info","ts":"2026-09-19T01:05:29.021403Z","caller":"traceutil/trace.go:171","msg":"trace[2034308850] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1; }","duration":"215.184807ms","start":"2026-09-19T01:05:28.806199Z","end":"2026-09-19T01:05:29.021384Z","steps":["trace[2034308850] 'count revisions from in-memory index tree' (duration: 214.874539ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.0216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.466914ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.021636Z","caller":"traceutil/trace.go:171","msg":"trace[262474404] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1; }","duration":"215.542076ms","start":"2026-09-19T01:05:28.806083Z","end":"2026-09-19T01:05:29.021625Z","steps":["trace[262474404] 'range keys from in-memory index tree' (duration: 215.153426ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.021819Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.708135ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.021864Z","caller":"traceutil/trace.go:171","msg":"trace[1351816516] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1; }","duration":"158.805897ms","start":"2026-09-19T01:05:28.863048Z","end":"2026-09-19T01:05:29.021853Z","steps":["trace[1351816516] 'count revisions from in-memory index tree' (duration: 158.637083ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.022365Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.662313ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.022486Z","caller":"traceutil/trace.go:171","msg":"trace[584052850] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"113.812568ms","start":"2026-09-19T01:05:28.908651Z","end":"2026-09-19T01:05:29.022464Z","steps":["trace[584052850] 'count revisions from in-memory index tree' (duration: 113.498638ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.022481Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.673508ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-09-19T01:05:29.022809Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.800131ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.022712Z","caller":"traceutil/trace.go:171","msg":"trace[1712663897] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"129.920024ms","start":"2026-09-19T01:05:28.892758Z","end":"2026-09-19T01:05:29.022678Z","steps":["trace[1712663897] 'count revisions from in-memory index tree' (duration: 129.552704ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:05:29.022855Z","caller":"traceutil/trace.go:171","msg":"trace[1638332925] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"129.893223ms","start":"2026-09-19T01:05:28.892948Z","end":"2026-09-19T01:05:29.022841Z","steps":["trace[1638332925] 'range keys from in-memory index tree' (duration: 129.76073ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.023119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.629939ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.02316Z","caller":"traceutil/trace.go:171","msg":"trace[910988308] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"114.697861ms","start":"2026-09-19T01:05:28.908451Z","end":"2026-09-19T01:05:29.023149Z","steps":["trace[910988308] 'range keys from in-memory index tree' (duration: 114.484636ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.023388Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.208177ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.023508Z","caller":"traceutil/trace.go:171","msg":"trace[1710675298] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1; }","duration":"100.523696ms","start":"2026-09-19T01:05:28.922963Z","end":"2026-09-19T01:05:29.023487Z","steps":["trace[1710675298] 'range keys from in-memory index tree' (duration: 99.989542ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:05:29.023368Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.65233ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-09-19T01:05:29.023459Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.61726ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-09-19T01:05:29.024087Z","caller":"traceutil/trace.go:171","msg":"trace[1576239953] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"146.275978ms","start":"2026-09-19T01:05:28.877771Z","end":"2026-09-19T01:05:29.024047Z","steps":["trace[1576239953] 'range keys from in-memory index tree' (duration: 145.512486ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:05:29.023979Z","caller":"traceutil/trace.go:171","msg":"trace[415910007] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"146.273968ms","start":"2026-09-19T01:05:28.877676Z","end":"2026-09-19T01:05:29.02395Z","steps":["trace[415910007] 'count revisions from in-memory index tree' (duration: 145.574608ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:06:15.485325Z","caller":"traceutil/trace.go:171","msg":"trace[914388407] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"136.387535ms","start":"2026-09-19T01:06:15.348882Z","end":"2026-09-19T01:06:15.485269Z","steps":["trace[914388407] 'process raft request' (duration: 135.483691ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:06:15.634623Z","caller":"traceutil/trace.go:171","msg":"trace[1123166498] transaction","detail":"{read_only:false; response_revision:645; number_of_response:1; }","duration":"141.395003ms","start":"2026-09-19T01:06:15.493191Z","end":"2026-09-19T01:06:15.634586Z","steps":["trace[1123166498] 'process raft request' (duration: 53.411178ms)","trace[1123166498] 'compare' (duration: 87.690807ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:06:16.515171Z","caller":"traceutil/trace.go:171","msg":"trace[1340054308] transaction","detail":"{read_only:false; response_revision:647; number_of_response:1; }","duration":"469.703515ms","start":"2026-09-19T01:06:16.04543Z","end":"2026-09-19T01:06:16.515133Z","steps":["trace[1340054308] 'process raft request' (duration: 468.992257ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:06:16.516017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:06:16.045393Z","time spent":"469.89143ms","remote":"127.0.0.1:59512","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036281,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-09-19T01:06:33.590129Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.195774ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-vvdrc\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-09-19T01:06:33.590387Z","caller":"traceutil/trace.go:171","msg":"trace[832864217] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-vvdrc; range_end:; response_count:1; response_revision:814; }","duration":"174.528723ms","start":"2026-09-19T01:06:33.415819Z","end":"2026-09-19T01:06:33.590348Z","steps":["trace[832864217] 'range keys from in-memory index tree' (duration: 173.622119ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:06:33.774602Z","caller":"traceutil/trace.go:171","msg":"trace[1007049660] linearizableReadLoop","detail":"{readStateIndex:850; appliedIndex:849; }","duration":"120.22473ms","start":"2026-09-19T01:06:33.654344Z","end":"2026-09-19T01:06:33.774568Z","steps":["trace[1007049660] 'read index received' (duration: 120.021274ms)","trace[1007049660] 'applied index is now lower than readState.Index' (duration: 202.006µs)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:06:33.774681Z","caller":"traceutil/trace.go:171","msg":"trace[1765517004] transaction","detail":"{read_only:false; response_revision:815; number_of_response:1; }","duration":"173.840565ms","start":"2026-09-19T01:06:33.600805Z","end":"2026-09-19T01:06:33.774646Z","steps":["trace[1765517004] 'process raft request' (duration: 173.572048ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:06:33.774882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.500508ms","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-09-19T01:06:33.774991Z","caller":"traceutil/trace.go:171","msg":"trace[1630559716] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:815; }","duration":"120.750333ms","start":"2026-09-19T01:06:33.654218Z","end":"2026-09-19T01:06:33.774969Z","steps":["trace[1630559716] 'agreement among raft nodes before linearized reading' (duration: 120.493877ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:02.041433Z","caller":"traceutil/trace.go:171","msg":"trace[1092305383] transaction","detail":"{read_only:false; response_revision:1001; number_of_response:1; }","duration":"107.481314ms","start":"2026-09-19T01:07:01.933908Z","end":"2026-09-19T01:07:02.041389Z","steps":["trace[1092305383] 'process raft request' (duration: 91.120595ms)","trace[1092305383] 'compare' (duration: 16.153674ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:04.211211Z","caller":"traceutil/trace.go:171","msg":"trace[953722421] transaction","detail":"{read_only:false; response_revision:1009; number_of_response:1; }","duration":"160.161025ms","start":"2026-09-19T01:07:04.051013Z","end":"2026-09-19T01:07:04.211174Z","steps":["trace[953722421] 'process raft request' (duration: 159.850447ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:14.311554Z","caller":"traceutil/trace.go:171","msg":"trace[1146991177] transaction","detail":"{read_only:false; response_revision:1047; number_of_response:1; }","duration":"135.43819ms","start":"2026-09-19T01:07:14.176087Z","end":"2026-09-19T01:07:14.311525Z","steps":["trace[1146991177] 'process raft request' (duration: 108.070669ms)","trace[1146991177] 'compare' (duration: 26.999261ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:14.312066Z","caller":"traceutil/trace.go:171","msg":"trace[396142674] transaction","detail":"{read_only:false; response_revision:1048; number_of_response:1; }","duration":"135.326878ms","start":"2026-09-19T01:07:14.176724Z","end":"2026-09-19T01:07:14.31205Z","steps":["trace[396142674] 'process raft request' (duration: 134.697581ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:14.48417Z","caller":"traceutil/trace.go:171","msg":"trace[360649642] transaction","detail":"{read_only:false; response_revision:1055; number_of_response:1; }","duration":"141.471925ms","start":"2026-09-19T01:07:14.342661Z","end":"2026-09-19T01:07:14.484133Z","steps":["trace[360649642] 'process raft request' (duration: 141.247579ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:18.08607Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.050348ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-09-19T01:07:18.086168Z","caller":"traceutil/trace.go:171","msg":"trace[459556894] linearizableReadLoop","detail":"{readStateIndex:1154; appliedIndex:1153; }","duration":"294.696511ms","start":"2026-09-19T01:07:17.791457Z","end":"2026-09-19T01:07:18.086154Z","steps":["trace[459556894] 'read index received' (duration: 26.402057ms)","trace[459556894] 'applied index is now lower than readState.Index' (duration: 268.293104ms)"],"step_count":2} {"level":"warn","ts":"2026-09-19T01:07:18.086287Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.830195ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-19T01:07:18.086305Z","caller":"traceutil/trace.go:171","msg":"trace[1378598945] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1108; }","duration":"294.887766ms","start":"2026-09-19T01:07:17.791409Z","end":"2026-09-19T01:07:18.086297Z","steps":["trace[1378598945] 'agreement among raft nodes before linearized reading' (duration: 294.835205ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:35.507517Z","caller":"traceutil/trace.go:171","msg":"trace[1912009824] transaction","detail":"{read_only:false; response_revision:1184; number_of_response:1; }","duration":"177.97155ms","start":"2026-09-19T01:07:35.329512Z","end":"2026-09-19T01:07:35.507484Z","steps":["trace[1912009824] 'process raft request' (duration: 177.766955ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:35.766883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.409778ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-09-19T01:07:35.76707Z","caller":"traceutil/trace.go:171","msg":"trace[1646365243] transaction","detail":"{read_only:false; response_revision:1186; number_of_response:1; }","duration":"255.353473ms","start":"2026-09-19T01:07:35.511692Z","end":"2026-09-19T01:07:35.767045Z","steps":["trace[1646365243] 'process raft request' (duration: 255.300412ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:35.767055Z","caller":"traceutil/trace.go:171","msg":"trace[600404106] transaction","detail":"{read_only:false; response_revision:1185; number_of_response:1; }","duration":"255.790273ms","start":"2026-09-19T01:07:35.511216Z","end":"2026-09-19T01:07:35.767007Z","steps":["trace[600404106] 'process raft request' (duration: 129.167069ms)","trace[600404106] 'compare' (duration: 126.241684ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:35.767288Z","caller":"traceutil/trace.go:171","msg":"trace[684495064] linearizableReadLoop","detail":"{readStateIndex:1235; appliedIndex:1234; }","duration":"256.00467ms","start":"2026-09-19T01:07:35.511273Z","end":"2026-09-19T01:07:35.767278Z","steps":["trace[684495064] 'read index received' (duration: 129.092877ms)","trace[684495064] 'applied index is now lower than readState.Index' (duration: 126.911053ms)"],"step_count":2} {"level":"warn","ts":"2026-09-19T01:07:35.767367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"256.068471ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:1 size:664"} {"level":"info","ts":"2026-09-19T01:07:35.767391Z","caller":"traceutil/trace.go:171","msg":"trace[1723878767] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:1; response_revision:1186; }","duration":"256.137793ms","start":"2026-09-19T01:07:35.511246Z","end":"2026-09-19T01:07:35.767384Z","steps":["trace[1723878767] 'agreement among raft nodes before linearized reading' (duration: 256.057001ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:36.890051Z","caller":"traceutil/trace.go:171","msg":"trace[865314915] linearizableReadLoop","detail":"{readStateIndex:1240; appliedIndex:1239; }","duration":"417.665611ms","start":"2026-09-19T01:07:36.47236Z","end":"2026-09-19T01:07:36.890026Z","steps":["trace[865314915] 'read index received' (duration: 417.634451ms)","trace[865314915] 'applied index is now lower than readState.Index' (duration: 30.19µs)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:36.890163Z","caller":"traceutil/trace.go:171","msg":"trace[20157752] transaction","detail":"{read_only:false; response_revision:1190; number_of_response:1; }","duration":"532.76872ms","start":"2026-09-19T01:07:36.357353Z","end":"2026-09-19T01:07:36.890122Z","steps":["trace[20157752] 'process raft request' (duration: 532.517363ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:36.890312Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"417.931469ms","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-09-19T01:07:36.890344Z","caller":"traceutil/trace.go:171","msg":"trace[459301939] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1190; }","duration":"418.026761ms","start":"2026-09-19T01:07:36.472307Z","end":"2026-09-19T01:07:36.890334Z","steps":["trace[459301939] 'agreement among raft nodes before linearized reading' (duration: 417.840105ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:36.890374Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:07:36.472286Z","time spent":"418.081273ms","remote":"127.0.0.1:59684","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-09-19T01:07:36.890375Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:07:36.357322Z","time spent":"532.958226ms","remote":"127.0.0.1:59592","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5640,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-09-19T01:07:36.92416Z","caller":"traceutil/trace.go:171","msg":"trace[1051884244] transaction","detail":"{read_only:false; response_revision:1191; number_of_response:1; }","duration":"164.362072ms","start":"2026-09-19T01:07:36.75976Z","end":"2026-09-19T01:07:36.924122Z","steps":["trace[1051884244] 'process raft request' (duration: 164.138166ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:36.924241Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.920351ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-19T01:07:36.924263Z","caller":"traceutil/trace.go:171","msg":"trace[671455183] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1191; }","duration":"131.970511ms","start":"2026-09-19T01:07:36.792283Z","end":"2026-09-19T01:07:36.924254Z","steps":["trace[671455183] 'agreement among raft nodes before linearized reading' (duration: 131.93812ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:36.924196Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"446.643465ms","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-09-19T01:07:36.92438Z","caller":"traceutil/trace.go:171","msg":"trace[1798063096] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1191; }","duration":"446.87089ms","start":"2026-09-19T01:07:36.477491Z","end":"2026-09-19T01:07:36.924362Z","steps":["trace[1798063096] 'agreement among raft nodes before linearized reading' (duration: 446.543922ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:36.924436Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:07:36.477443Z","time spent":"446.974602ms","remote":"127.0.0.1:59684","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-09-19T01:07:37.037213Z","caller":"traceutil/trace.go:171","msg":"trace[946127179] transaction","detail":"{read_only:false; response_revision:1192; number_of_response:1; }","duration":"140.91351ms","start":"2026-09-19T01:07:36.896249Z","end":"2026-09-19T01:07:37.037163Z","steps":["trace[946127179] 'process raft request' (duration: 68.602288ms)","trace[946127179] 'compare' (duration: 72.073726ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:37.03722Z","caller":"traceutil/trace.go:171","msg":"trace[1321003609] linearizableReadLoop","detail":"{readStateIndex:1242; appliedIndex:1241; }","duration":"109.446265ms","start":"2026-09-19T01:07:36.927745Z","end":"2026-09-19T01:07:37.037191Z","steps":["trace[1321003609] 'read index received' (duration: 37.209324ms)","trace[1321003609] 'applied index is now lower than readState.Index' (duration: 72.235721ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:37.037462Z","caller":"traceutil/trace.go:171","msg":"trace[359704677] transaction","detail":"{read_only:false; response_revision:1193; number_of_response:1; }","duration":"105.952665ms","start":"2026-09-19T01:07:36.931486Z","end":"2026-09-19T01:07:37.037439Z","steps":["trace[359704677] 'process raft request' (duration: 105.650477ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:37.037571Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.796414ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-19T01:07:37.037627Z","caller":"traceutil/trace.go:171","msg":"trace[1447401334] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1193; }","duration":"109.882885ms","start":"2026-09-19T01:07:36.927727Z","end":"2026-09-19T01:07:37.037609Z","steps":["trace[1447401334] 'agreement among raft nodes before linearized reading' (duration: 109.578478ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:37.551082Z","caller":"traceutil/trace.go:171","msg":"trace[275350539] transaction","detail":"{read_only:false; response_revision:1200; number_of_response:1; }","duration":"196.490385ms","start":"2026-09-19T01:07:37.354559Z","end":"2026-09-19T01:07:37.55105Z","steps":["trace[275350539] 'process raft request' (duration: 126.645216ms)","trace[275350539] 'compare' (duration: 69.661154ms)"],"step_count":2} {"level":"info","ts":"2026-09-19T01:07:50.460947Z","caller":"traceutil/trace.go:171","msg":"trace[1973441459] linearizableReadLoop","detail":"{readStateIndex:1336; appliedIndex:1335; }","duration":"372.72529ms","start":"2026-09-19T01:07:50.088198Z","end":"2026-09-19T01:07:50.460924Z","steps":["trace[1973441459] 'read index received' (duration: 372.462363ms)","trace[1973441459] 'applied index is now lower than readState.Index' (duration: 262.267µs)"],"step_count":2} {"level":"warn","ts":"2026-09-19T01:07:50.461103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"372.875083ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-19T01:07:50.461068Z","caller":"traceutil/trace.go:171","msg":"trace[1604890225] transaction","detail":"{read_only:false; response_revision:1283; number_of_response:1; }","duration":"477.71459ms","start":"2026-09-19T01:07:49.983311Z","end":"2026-09-19T01:07:50.461025Z","steps":["trace[1604890225] 'process raft request' (duration: 477.486334ms)"],"step_count":1} {"level":"info","ts":"2026-09-19T01:07:50.461137Z","caller":"traceutil/trace.go:171","msg":"trace[1519292194] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:1283; }","duration":"372.973076ms","start":"2026-09-19T01:07:50.088154Z","end":"2026-09-19T01:07:50.461127Z","steps":["trace[1519292194] 'agreement among raft nodes before linearized reading' (duration: 372.886343ms)"],"step_count":1} {"level":"warn","ts":"2026-09-19T01:07:50.461155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:07:50.088021Z","time spent":"373.12855ms","remote":"127.0.0.1:39906","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"warn","ts":"2026-09-19T01:07:50.461252Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-19T01:07:49.983293Z","time spent":"477.863623ms","remote":"127.0.0.1:59684","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-09-19T01:07:50.588587Z","caller":"traceutil/trace.go:171","msg":"trace[683687120] transaction","detail":"{read_only:false; response_revision:1284; number_of_response:1; }","duration":"122.718825ms","start":"2026-09-19T01:07:50.465839Z","end":"2026-09-19T01:07:50.588557Z","steps":["trace[683687120] 'process raft request' (duration: 117.237174ms)"],"step_count":1}