2026-06-24T00:46:36.855Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-24T00:46:36.867Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-24T00:46:36.867Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-24T00:46:36.867Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-24T00:46:36.867Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-24T00:46:36.875Z|00006|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-24T00:46:44.007Z|00007|dpif_netlink|INFO|Datapath dispatch mode: per-cpu 2026-06-24T00:46:44.007Z|00008|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-24T00:46:44.008Z|00009|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-24T00:46:44.008Z|00010|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-24T00:46:44.008Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-24T00:46:44.008Z|00012|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-24T00:46:44.008Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-24T00:46:44.008Z|00014|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-24T00:46:44.008Z|00015|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-24T00:46:44.008Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-24T00:46:44.008Z|00017|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-24T00:46:44.008Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-24T00:46:44.008Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-24T00:46:44.008Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-24T00:46:44.008Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-24T00:46:44.008Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-24T00:46:44.008Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-24T00:46:44.008Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-24T00:46:44.009Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-24T00:46:44.009Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-24T00:46:44.009Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-24T00:46:44.009Z|00028|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-24T00:46:44.009Z|00029|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-24T00:46:44.009Z|00030|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-24T00:46:44.009Z|00031|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-24T00:46:44.167Z|00032|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-24T00:46:44.168Z|00033|bridge|INFO|bridge br-int: using datapath ID 0000027ed340ca38 2026-06-24T00:46:44.168Z|00034|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-24T00:46:47.174Z|00035|memory|INFO|199168 kB peak resident set size after 10.3 seconds 2026-06-24T00:46:47.175Z|00036|memory|INFO|handlers:16 idl-cells-Open_vSwitch:101 ports:1 revalidators:5 rules:4 2026-06-24T00:58:53.084Z|00037|bridge|INFO|bridge br-int: deleted interface br-int on port 65534 2026-06-24T00:58:53.943Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-24T00:58:53.952Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-24T00:58:53.952Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-24T00:58:53.952Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-24T00:58:53.953Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-24T00:58:54.006Z|00006|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-24T00:58:54.006Z|00007|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-24T00:58:54.006Z|00008|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-24T00:58:54.006Z|00009|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-24T00:58:54.006Z|00010|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-24T00:58:54.006Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-24T00:58:54.006Z|00012|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-24T00:58:54.006Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-24T00:58:54.006Z|00014|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-24T00:58:54.006Z|00015|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-24T00:58:54.006Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-24T00:58:54.006Z|00017|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-24T00:58:54.006Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-24T00:58:54.006Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-24T00:58:54.006Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-24T00:58:54.006Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-24T00:58:54.006Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-24T00:58:54.006Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-24T00:58:54.006Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-24T00:58:54.006Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-24T00:58:54.006Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-24T00:58:54.007Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-24T00:58:54.007Z|00028|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-24T00:58:54.007Z|00029|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-24T00:58:54.129Z|00030|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-24T00:58:54.129Z|00031|bridge|INFO|bridge br-int: using datapath ID 0000027ed340ca38 2026-06-24T00:58:54.129Z|00032|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-24T00:58:54.130Z|00033|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-24T00:58:54.447Z|00034|bridge|INFO|bridge br-int: deleted interface br-int on port 65534 2026-06-24T00:58:55.049Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-24T00:58:55.061Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-24T00:58:55.061Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-24T00:58:55.061Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-24T00:58:55.061Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-24T00:58:55.114Z|00006|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-24T00:58:55.114Z|00007|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-24T00:58:55.114Z|00008|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-24T00:58:55.114Z|00009|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-24T00:58:55.114Z|00010|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-24T00:58:55.114Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-24T00:58:55.115Z|00012|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-24T00:58:55.115Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-24T00:58:55.115Z|00014|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-24T00:58:55.115Z|00015|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-24T00:58:55.115Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-24T00:58:55.115Z|00017|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-24T00:58:55.115Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-24T00:58:55.115Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-24T00:58:55.115Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-24T00:58:55.115Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-24T00:58:55.115Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-24T00:58:55.115Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-24T00:58:55.115Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-24T00:58:55.115Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-24T00:58:55.115Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-24T00:58:55.115Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-24T00:58:55.116Z|00028|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-24T00:58:55.116Z|00029|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-24T00:58:55.243Z|00030|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-24T00:58:55.243Z|00031|bridge|INFO|bridge br-int: using datapath ID 0000027ed340ca38 2026-06-24T00:58:55.243Z|00032|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-24T00:58:55.244Z|00033|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-24T00:58:55.755Z|00034|bridge|INFO|bridge br-ex: added interface br-ex on port 65534 2026-06-24T00:58:55.756Z|00035|bridge|INFO|bridge br-ex: using datapath ID 0000f2721dd6fc45 2026-06-24T00:58:55.756Z|00036|connmgr|INFO|br-ex: added service controller "punix:/var/run/openvswitch/br-ex.mgmt" 2026-06-24T00:59:05.262Z|00037|memory|INFO|199664 kB peak resident set size after 10.2 seconds 2026-06-24T00:59:05.262Z|00038|memory|INFO|handlers:16 idl-cells-Open_vSwitch:199 ofconns:4 ports:2 revalidators:5 rules:26 2026-06-24T00:59:09.370Z|00039|connmgr|INFO|br-int<->unix#1: 18 flow_mods 10 s ago (17 adds, 1 deletes) 2026-06-24T00:59:39.104Z|00040|bridge|INFO|bridge br-int: added interface patch-br-int-to-provnet-acb54192-96df-4e7c-b767-cbda9e3608da on port 1 2026-06-24T00:59:39.104Z|00041|bridge|INFO|bridge br-ex: added interface patch-provnet-acb54192-96df-4e7c-b767-cbda9e3608da-to-br-int on port 1 2026-06-24T01:00:09.370Z|00042|connmgr|INFO|br-int<->unix#1: 554 flow_mods in the 4 s starting 30 s ago (539 adds, 8 deletes, 7 modifications) 2026-06-24T01:03:28.132Z|00043|bridge|INFO|bridge br-int: added interface tap1b90da81-11 on port 2 2026-06-24T01:03:30.843Z|00044|bridge|INFO|bridge br-int: added interface tapa0e9ad43-d0 on port 3 2026-06-24T01:03:38.185Z|00045|connmgr|INFO|br-int<->unix#1: 159 flow_mods in the 2 s starting 10 s ago (157 adds, 2 deletes) 2026-06-24T01:04:38.185Z|00046|connmgr|INFO|br-int<->unix#1: 463 flow_mods in the 25 s starting 34 s ago (448 adds, 11 deletes, 4 modifications) 2026-06-24T01:05:11.143Z|00047|bridge|WARN|could not open network device tap6765f001-b3 (No such device) 2026-06-24T01:05:12.725Z|00048|bridge|INFO|bridge br-int: added interface tap6765f001-b3 on port 4 2026-06-24T01:05:13.222Z|00049|bridge|INFO|bridge br-int: added interface tapb607fd70-10 on port 5 2026-06-24T01:05:38.186Z|00050|connmgr|INFO|br-int<->unix#1: 213 flow_mods in the 19 s starting 25 s ago (199 adds, 10 deletes, 4 modifications) 2026-06-24T01:06:38.184Z|00051|connmgr|INFO|br-int<->unix#1: 8 flow_mods 37 s ago (4 adds, 4 deletes) 2026-06-24T01:07:38.185Z|00052|connmgr|INFO|br-int<->unix#1: 8 flow_mods 16 s ago (4 adds, 4 deletes) 2026-06-24T01:08:01.862Z|00053|bridge|WARN|could not open network device tap000b2a89-4f (No such device) 2026-06-24T01:08:03.432Z|00054|bridge|INFO|bridge br-int: added interface tap000b2a89-4f on port 6 2026-06-24T01:08:03.908Z|00055|bridge|WARN|could not open network device tap50c3cd6c-80 (No such device) 2026-06-24T01:08:05.640Z|00056|bridge|INFO|bridge br-int: added interface tap50c3cd6c-80 on port 7 2026-06-24T01:08:38.185Z|00057|connmgr|INFO|br-int<->unix#1: 1014 flow_mods in the 15 s starting 47 s ago (748 adds, 266 deletes) 2026-06-24T01:09:04.092Z|00058|timeval|WARN|Unreasonably long 3047ms poll interval (1767ms user, 1253ms system) 2026-06-24T01:09:04.092Z|00059|timeval|WARN|context switches: 0 voluntary, 133 involuntary 2026-06-24T01:09:04.092Z|00060|coverage|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=bed5495f: 2026-06-24T01:09:04.092Z|00061|coverage|INFO|nln_changed 0.0/sec 0.533/sec 0.0283/sec total: 102 2026-06-24T01:09:04.092Z|00062|coverage|INFO|route_table_dump 0.0/sec 0.350/sec 0.0194/sec total: 70 2026-06-24T01:09:04.092Z|00063|coverage|INFO|netlink_sent 31.4/sec 60.567/sec 3.5439/sec total: 12758 2026-06-24T01:09:04.092Z|00064|coverage|INFO|netlink_recv_jumbo 3.2/sec 15.200/sec 0.5942/sec total: 2139 2026-06-24T01:09:04.092Z|00065|coverage|INFO|netlink_received 29.8/sec 64.033/sec 4.1164/sec total: 14819 2026-06-24T01:09:04.092Z|00066|coverage|INFO|netdev_set_ethtool 0.0/sec 0.033/sec 0.0014/sec total: 5 2026-06-24T01:09:04.092Z|00067|coverage|INFO|netdev_get_ethtool 0.0/sec 0.233/sec 0.0081/sec total: 29 2026-06-24T01:09:04.092Z|00068|coverage|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00069|coverage|INFO|netdev_set_policing 0.0/sec 0.167/sec 0.0083/sec total: 30 2026-06-24T01:09:04.092Z|00070|coverage|INFO|vconn_sent 0.2/sec 0.667/sec 0.0611/sec total: 220 2026-06-24T01:09:04.092Z|00071|coverage|INFO|vconn_received 0.2/sec 17.400/sec 0.7511/sec total: 2704 2026-06-24T01:09:04.092Z|00072|coverage|INFO|util_xalloc 923.8/sec 1706.050/sec 119.8750/sec total: 431550 2026-06-24T01:09:04.092Z|00073|coverage|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00074|coverage|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-24T01:09:04.092Z|00075|coverage|INFO|seq_change 1088.2/sec 1181.217/sec 185.9178/sec total: 669304 2026-06-24T01:09:04.092Z|00076|coverage|INFO|rconn_sent 0.2/sec 0.667/sec 0.0600/sec total: 216 2026-06-24T01:09:04.092Z|00077|coverage|INFO|rconn_queued 0.2/sec 0.667/sec 0.0600/sec total: 216 2026-06-24T01:09:04.092Z|00078|coverage|INFO|poll_zero_timeout 7.4/sec 5.750/sec 0.2731/sec total: 983 2026-06-24T01:09:04.092Z|00079|coverage|INFO|poll_create_node 218.6/sec 262.967/sec 32.7006/sec total: 117722 2026-06-24T01:09:04.092Z|00080|coverage|INFO|txn_success 0.2/sec 0.267/sec 0.0217/sec total: 78 2026-06-24T01:09:04.092Z|00081|coverage|INFO|txn_incomplete 0.2/sec 0.550/sec 0.0322/sec total: 116 2026-06-24T01:09:04.092Z|00082|coverage|INFO|txn_unchanged 0.0/sec 0.450/sec 0.0464/sec total: 167 2026-06-24T01:09:04.092Z|00083|coverage|INFO|netdev_get_stats 2.0/sec 2.000/sec 0.1994/sec total: 718 2026-06-24T01:09:04.092Z|00084|coverage|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00085|coverage|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-24T01:09:04.092Z|00086|coverage|INFO|hmap_expand 20.4/sec 39.800/sec 3.9783/sec total: 14322 2026-06-24T01:09:04.092Z|00087|coverage|INFO|hmap_pathological 0.0/sec 0.017/sec 0.0036/sec total: 13 2026-06-24T01:09:04.092Z|00088|coverage|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-24T01:09:04.092Z|00089|coverage|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0031/sec total: 11 2026-06-24T01:09:04.092Z|00090|coverage|INFO|miniflow_malloc 0.6/sec 51.433/sec 2.2267/sec total: 8016 2026-06-24T01:09:04.092Z|00091|coverage|INFO|flow_extract 8.6/sec 6.083/sec 0.1878/sec total: 676 2026-06-24T01:09:04.092Z|00092|coverage|INFO|dpif_port_add 0.0/sec 0.033/sec 0.0019/sec total: 7 2026-06-24T01:09:04.092Z|00093|coverage|INFO|dpif_flow_put_error 1.8/sec 0.933/sec 0.0300/sec total: 108 2026-06-24T01:09:04.092Z|00094|coverage|INFO|dpif_flow_put 8.4/sec 4.917/sec 0.1597/sec total: 575 2026-06-24T01:09:04.092Z|00095|coverage|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-06-24T01:09:04.092Z|00096|coverage|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00097|coverage|INFO|dpif_flow_del 3.4/sec 2.617/sec 0.0947/sec total: 341 2026-06-24T01:09:04.092Z|00098|coverage|INFO|dpif_execute_with_help 0.4/sec 0.217/sec 0.0086/sec total: 31 2026-06-24T01:09:04.092Z|00099|coverage|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00100|coverage|INFO|dpif_execute 9.0/sec 6.083/sec 0.1950/sec total: 702 2026-06-24T01:09:04.092Z|00101|coverage|INFO|cmap_shrink 2.2/sec 6.183/sec 0.2947/sec total: 1061 2026-06-24T01:09:04.092Z|00102|coverage|INFO|cmap_expand 2.2/sec 8.317/sec 0.4711/sec total: 1696 2026-06-24T01:09:04.092Z|00103|coverage|INFO|ccmap_shrink 0.0/sec 2.267/sec 0.0378/sec total: 136 2026-06-24T01:09:04.092Z|00104|coverage|INFO|ccmap_expand 0.0/sec 0.033/sec 0.0078/sec total: 28 2026-06-24T01:09:04.092Z|00105|coverage|INFO|xlate_actions 10.6/sec 14.883/sec 0.4369/sec total: 1573 2026-06-24T01:09:04.092Z|00106|coverage|INFO|upcall_ukey_replace 0.0/sec 0.017/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00107|coverage|INFO|upcall_flow_limit_grew 0.2/sec 0.833/sec 0.0236/sec total: 85 2026-06-24T01:09:04.092Z|00108|coverage|INFO|handler_duplicate_upcall 0.2/sec 0.500/sec 0.0156/sec total: 56 2026-06-24T01:09:04.092Z|00109|coverage|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-24T01:09:04.092Z|00110|coverage|INFO|rev_flow_table 0.0/sec 0.067/sec 0.0097/sec total: 35 2026-06-24T01:09:04.092Z|00111|coverage|INFO|rev_port_toggled 0.0/sec 0.033/sec 0.0022/sec total: 8 2026-06-24T01:09:04.092Z|00112|coverage|INFO|rev_reconfigure 0.0/sec 0.033/sec 0.0022/sec total: 8 2026-06-24T01:09:04.092Z|00113|coverage|INFO|ofproto_update_port 0.0/sec 0.200/sec 0.0119/sec total: 43 2026-06-24T01:09:04.092Z|00114|coverage|INFO|ofproto_recv_openflow 0.2/sec 17.400/sec 0.7500/sec total: 2700 2026-06-24T01:09:04.092Z|00115|coverage|INFO|ofproto_packet_out 0.0/sec 0.200/sec 0.0147/sec total: 53 2026-06-24T01:09:04.092Z|00116|coverage|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.092Z|00117|coverage|INFO|bridge_reconfigure 0.0/sec 0.350/sec 0.0178/sec total: 64 2026-06-24T01:09:04.092Z|00118|coverage|INFO|114 events never hit 2026-06-24T01:09:04.092Z|00119|poll_loop|INFO|wakeup due to [POLLIN] on fd 15 (<->/var/run/openvswitch/db.sock) at ../lib/stream-fd.c:157 (67% CPU usage) 2026-06-24T01:09:04.092Z|00120|poll_loop|INFO|wakeup due to [POLLIN] on fd 68 (/var/run/openvswitch/br-int.mgmt<->) at ../lib/stream-fd.c:157 (67% CPU usage) 2026-06-24T01:09:04.096Z|00001|timeval(revalidator19)|WARN|Unreasonably long 2772ms poll interval (0ms user, 0ms system) 2026-06-24T01:09:04.096Z|00002|timeval(revalidator19)|WARN|context switches: 1 voluntary, 0 involuntary 2026-06-24T01:09:04.097Z|00001|timeval(revalidator18)|WARN|Unreasonably long 2773ms poll interval (0ms user, 0ms system) 2026-06-24T01:09:04.097Z|00002|timeval(revalidator18)|WARN|context switches: 1 voluntary, 0 involuntary 2026-06-24T01:09:04.098Z|00003|coverage(revalidator18)|INFO|Skipping details of duplicate event coverage for hash=4bc839f2 2026-06-24T01:09:04.099Z|00001|timeval(revalidator22)|WARN|Unreasonably long 2775ms poll interval (0ms user, 0ms system) 2026-06-24T01:09:04.099Z|00002|timeval(revalidator22)|WARN|context switches: 1 voluntary, 0 involuntary 2026-06-24T01:09:04.100Z|00001|timeval(revalidator20)|WARN|Unreasonably long 2774ms poll interval (0ms user, 0ms system) 2026-06-24T01:09:04.100Z|00002|timeval(revalidator20)|WARN|context switches: 1 voluntary, 0 involuntary 2026-06-24T01:09:04.101Z|00121|poll_loop|INFO|wakeup due to [POLLIN] on fd 61 (FIFO pipe:[201680]) at ../vswitchd/bridge.c:424 (67% CPU usage) 2026-06-24T01:09:04.102Z|00122|poll_loop|INFO|wakeup due to [POLLIN] on fd 68 (/var/run/openvswitch/br-int.mgmt<->) at ../lib/stream-fd.c:157 (67% CPU usage) 2026-06-24T01:09:04.104Z|00003|coverage(revalidator19)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=4bc839f2: 2026-06-24T01:09:04.104Z|00004|coverage(revalidator19)|INFO|nln_changed 0.0/sec 0.533/sec 0.0283/sec total: 102 2026-06-24T01:09:04.104Z|00005|coverage(revalidator19)|INFO|route_table_dump 0.0/sec 0.350/sec 0.0194/sec total: 70 2026-06-24T01:09:04.104Z|00006|coverage(revalidator19)|INFO|netlink_sent 31.4/sec 60.567/sec 3.5439/sec total: 12772 2026-06-24T01:09:04.104Z|00007|coverage(revalidator19)|INFO|netlink_recv_jumbo 3.2/sec 15.200/sec 0.5942/sec total: 2144 2026-06-24T01:09:04.104Z|00008|coverage(revalidator19)|INFO|netlink_received 29.8/sec 64.033/sec 4.1164/sec total: 14833 2026-06-24T01:09:04.104Z|00009|coverage(revalidator19)|INFO|netdev_set_ethtool 0.0/sec 0.033/sec 0.0014/sec total: 5 2026-06-24T01:09:04.104Z|00010|coverage(revalidator19)|INFO|netdev_get_ethtool 0.0/sec 0.233/sec 0.0081/sec total: 29 2026-06-24T01:09:04.104Z|00011|coverage(revalidator19)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00012|coverage(revalidator19)|INFO|netdev_set_policing 0.0/sec 0.167/sec 0.0083/sec total: 30 2026-06-24T01:09:04.104Z|00013|coverage(revalidator19)|INFO|vconn_sent 0.2/sec 0.667/sec 0.0611/sec total: 220 2026-06-24T01:09:04.104Z|00014|coverage(revalidator19)|INFO|vconn_received 0.2/sec 17.400/sec 0.7511/sec total: 2705 2026-06-24T01:09:04.104Z|00015|coverage(revalidator19)|INFO|util_xalloc 923.8/sec 1706.050/sec 119.8750/sec total: 433344 2026-06-24T01:09:04.104Z|00016|coverage(revalidator19)|INFO|long_poll_interval 0.0/sec 0.000/sec 0.0000/sec total: 1 2026-06-24T01:09:04.104Z|00017|coverage(revalidator19)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00018|coverage(revalidator19)|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-24T01:09:04.104Z|00019|coverage(revalidator19)|INFO|seq_change 1088.2/sec 1181.217/sec 185.9178/sec total: 669522 2026-06-24T01:09:04.104Z|00020|coverage(revalidator19)|INFO|rconn_sent 0.2/sec 0.667/sec 0.0600/sec total: 216 2026-06-24T01:09:04.104Z|00021|coverage(revalidator19)|INFO|rconn_queued 0.2/sec 0.667/sec 0.0600/sec total: 216 2026-06-24T01:09:04.104Z|00022|coverage(revalidator19)|INFO|poll_zero_timeout 7.4/sec 5.750/sec 0.2731/sec total: 983 2026-06-24T01:09:04.104Z|00023|coverage(revalidator19)|INFO|poll_create_node 218.6/sec 262.967/sec 32.7006/sec total: 117822 2026-06-24T01:09:04.104Z|00024|coverage(revalidator19)|INFO|txn_success 0.2/sec 0.267/sec 0.0217/sec total: 79 2026-06-24T01:09:04.104Z|00025|coverage(revalidator19)|INFO|txn_incomplete 0.2/sec 0.550/sec 0.0322/sec total: 117 2026-06-24T01:09:04.104Z|00026|coverage(revalidator19)|INFO|txn_unchanged 0.0/sec 0.450/sec 0.0464/sec total: 167 2026-06-24T01:09:04.104Z|00027|coverage(revalidator19)|INFO|netdev_get_stats 2.0/sec 2.000/sec 0.1994/sec total: 728 2026-06-24T01:09:04.104Z|00028|coverage(revalidator19)|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00029|coverage(revalidator19)|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-24T01:09:04.104Z|00030|coverage(revalidator19)|INFO|hmap_expand 20.4/sec 39.800/sec 3.9783/sec total: 14352 2026-06-24T01:09:04.104Z|00031|coverage(revalidator19)|INFO|hmap_pathological 0.0/sec 0.017/sec 0.0036/sec total: 13 2026-06-24T01:09:04.104Z|00032|coverage(revalidator19)|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-24T01:09:04.104Z|00033|coverage(revalidator19)|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0031/sec total: 11 2026-06-24T01:09:04.104Z|00034|coverage(revalidator19)|INFO|miniflow_malloc 0.6/sec 51.433/sec 2.2267/sec total: 8016 2026-06-24T01:09:04.104Z|00035|coverage(revalidator19)|INFO|flow_extract 8.6/sec 6.083/sec 0.1878/sec total: 676 2026-06-24T01:09:04.104Z|00036|coverage(revalidator19)|INFO|dpif_port_add 0.0/sec 0.033/sec 0.0019/sec total: 7 2026-06-24T01:09:04.104Z|00037|coverage(revalidator19)|INFO|dpif_flow_put_error 1.8/sec 0.933/sec 0.0300/sec total: 108 2026-06-24T01:09:04.104Z|00038|coverage(revalidator19)|INFO|dpif_flow_put 8.4/sec 4.917/sec 0.1597/sec total: 575 2026-06-24T01:09:04.104Z|00039|coverage(revalidator19)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-06-24T01:09:04.104Z|00040|coverage(revalidator19)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00041|coverage(revalidator19)|INFO|dpif_flow_del 3.4/sec 2.617/sec 0.0947/sec total: 341 2026-06-24T01:09:04.104Z|00042|coverage(revalidator19)|INFO|dpif_execute_with_help 0.4/sec 0.217/sec 0.0086/sec total: 31 2026-06-24T01:09:04.104Z|00043|coverage(revalidator19)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00044|coverage(revalidator19)|INFO|dpif_execute 9.0/sec 6.083/sec 0.1950/sec total: 703 2026-06-24T01:09:04.104Z|00045|coverage(revalidator19)|INFO|cmap_shrink 2.2/sec 6.183/sec 0.2947/sec total: 1063 2026-06-24T01:09:04.104Z|00046|coverage(revalidator19)|INFO|cmap_expand 2.2/sec 8.317/sec 0.4711/sec total: 1696 2026-06-24T01:09:04.104Z|00047|coverage(revalidator19)|INFO|ccmap_shrink 0.0/sec 2.267/sec 0.0378/sec total: 136 2026-06-24T01:09:04.104Z|00048|coverage(revalidator19)|INFO|ccmap_expand 0.0/sec 0.033/sec 0.0078/sec total: 28 2026-06-24T01:09:04.104Z|00049|coverage(revalidator19)|INFO|xlate_actions 10.6/sec 14.883/sec 0.4369/sec total: 1574 2026-06-24T01:09:04.104Z|00050|coverage(revalidator19)|INFO|upcall_ukey_replace 0.0/sec 0.017/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00051|coverage(revalidator19)|INFO|upcall_flow_limit_grew 0.2/sec 0.833/sec 0.0236/sec total: 85 2026-06-24T01:09:04.104Z|00052|coverage(revalidator19)|INFO|handler_duplicate_upcall 0.2/sec 0.500/sec 0.0156/sec total: 56 2026-06-24T01:09:04.104Z|00053|coverage(revalidator19)|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-24T01:09:04.104Z|00054|coverage(revalidator19)|INFO|rev_flow_table 0.0/sec 0.067/sec 0.0097/sec total: 35 2026-06-24T01:09:04.104Z|00055|coverage(revalidator19)|INFO|rev_port_toggled 0.0/sec 0.033/sec 0.0022/sec total: 8 2026-06-24T01:09:04.104Z|00056|coverage(revalidator19)|INFO|rev_reconfigure 0.0/sec 0.033/sec 0.0022/sec total: 8 2026-06-24T01:09:04.104Z|00057|coverage(revalidator19)|INFO|ofproto_update_port 0.0/sec 0.200/sec 0.0119/sec total: 43 2026-06-24T01:09:04.104Z|00058|coverage(revalidator19)|INFO|ofproto_recv_openflow 0.2/sec 17.400/sec 0.7500/sec total: 2701 2026-06-24T01:09:04.104Z|00059|coverage(revalidator19)|INFO|ofproto_packet_out 0.0/sec 0.200/sec 0.0147/sec total: 54 2026-06-24T01:09:04.104Z|00060|coverage(revalidator19)|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-24T01:09:04.104Z|00061|coverage(revalidator19)|INFO|bridge_reconfigure 0.0/sec 0.350/sec 0.0178/sec total: 64 2026-06-24T01:09:04.104Z|00062|coverage(revalidator19)|INFO|113 events never hit 2026-06-24T01:09:04.105Z|00004|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 2781ms dumping flows 2026-06-24T01:09:04.105Z|00123|poll_loop|INFO|wakeup due to [POLLIN] on fd 61 (FIFO pipe:[201680]) at ../vswitchd/bridge.c:424 (67% CPU usage) 2026-06-24T01:09:04.108Z|00124|poll_loop|INFO|wakeup due to [POLLIN] on fd 69 (/var/run/openvswitch/br-int.mgmt<->) at ../lib/stream-fd.c:157 (67% CPU usage) 2026-06-24T01:09:04.109Z|00125|poll_loop|INFO|wakeup due to 0-ms timeout at ../ofproto/ofproto-dpif.c:1998 (67% CPU usage) 2026-06-24T01:09:04.609Z|00126|poll_loop|INFO|wakeup due to [POLLIN] on fd 61 (FIFO pipe:[201680]) at ../vswitchd/bridge.c:424 (67% CPU usage) 2026-06-24T01:09:05.109Z|00127|poll_loop|INFO|wakeup due to [POLLIN] on fd 61 (FIFO pipe:[201680]) at ../vswitchd/bridge.c:424 (67% CPU usage) 2026-06-24T01:09:05.611Z|00128|poll_loop|INFO|wakeup due to [POLLIN] on fd 61 (FIFO pipe:[201680]) at ../vswitchd/bridge.c:424 (67% CPU usage) 2026-06-24T01:09:48.845Z|00129|connmgr|INFO|br-int<->unix#1: 18 flow_mods 10 s ago (9 adds, 9 deletes) 2026-06-24T01:26:46.827Z|00005|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 2324ms dumping flows