2025-07-23 13:11:18,738 - DEBUG - [10.0.0.65]: Running cmd : hostname
2025-07-23 13:11:19,000 - DEBUG - Output : cn-jenkins-deploy-platform-ansible-k8s-397-1.novalocal
2025-07-23 13:11:19,001 - DEBUG - [10.0.0.65]: Running cmd : hostname -f
2025-07-23 13:11:19,111 - DEBUG - Output : cn-jenkins-deploy-platform-ansible-k8s-397-1.novalocal
2025-07-23 13:11:19,111 - DEBUG - [10.0.0.65]: Running cmd : docker ps 2>/dev/null | grep -v "/pause\|/usr/bin/pod\|nova_api_\|contrail.*init\|init.*contrail\|provisioner\|placement" | awk '{print $NF}'
2025-07-23 13:11:19,310 - DEBUG - Output : NAMES
contrail_test_MVnq7a7L9
vrouter_vrouter-agent_1
vrouter_nodemgr_1
rsyslogd_rsyslogd_1
kubemanager_k8s_kubemanager_1
analytics_snmp_snmp-collector_1
analytics_snmp_topology_1
analytics_snmp_nodemgr_1
analytics_alarm_nodemgr_1
analytics_alarm_alarm-gen_1
analytics_alarm_kafka_1
analytics_api_1
analytics_nodemgr_1
analytics_collector_1
analytics_database_nodemgr_1
analytics_database_query-engine_1
analytics_database_cassandra_1
control_named_1
control_dns_1
control_nodemgr_1
control_control_1
webui_job_1
webui_web_1
config_devicemgr_1
config_nodemgr_1
config_schema_1
config_api_1
config_dnsmasq_1
config_svcmonitor_1
config_database_rabbitmq_1
config_database_nodemgr_1
config_database_cassandra_1
config_database_zookeeper_1
redis_redis_1
2025-07-23 13:11:19,310 - DEBUG - [10.0.0.65]: Running cmd : ip addr show | grep 'inet .*/.* brd ' | awk '{print $2}'
2025-07-23 13:11:19,427 - DEBUG - Output : 10.0.0.65/24
10.20.0.254/24
172.17.0.1/16
10.20.0.254/24
2025-07-23 13:11:19,427 - DEBUG - [10.0.0.65]: Running cmd : getent hosts 10.0.0.65 | head -n 1 | awk '{print $2}'
2025-07-23 13:11:19,542 - DEBUG - Output : cn-jenkins-deploy-platform-ansible-k8s-397-1.novalocal
2025-07-23 13:11:19,543 - DEBUG - [10.0.0.65]: Running cmd : ip addr show dev vhost0 | grep 'inet .*/.* brd ' | awk '{print $2}'
2025-07-23 13:11:19,657 - DEBUG - Output : 10.20.0.254/24
2025-07-23 13:11:19,658 - DEBUG - [10.0.0.65]: Running cmd : getent hosts 10.20.0.254 | head -n 1 | awk '{print $2}'
2025-07-23 13:11:19,766 - DEBUG - Output : cn-jenkins-deploy-platform-ansible-k8s-397-1.novalocal
2025-07-23 13:11:20,052 - INFO - Using existing project ['default-domain', 'k8s-default'](11383923-2f93-4b2c-b4b3-a6da7905dd4d)
2025-07-23 13:11:20,129 - INFO - Using existing project ['default-domain', 'k8s-default'](11383923-2f93-4b2c-b4b3-a6da7905dd4d)
2025-07-23 13:11:20,275 - INFO - ================================================================================
2025-07-23 13:11:20,275 - INFO - STARTING TEST : test_ingress_ip_assignment
2025-07-23 13:11:20,276 - INFO - TEST DESCRIPTION :
Verify that Ingress gets a CLuster IP which is reachable to Pods in same
namespace. Also verify that a Floating IP is assigned to the Ingress
from the Public FIP poo.
Steps:
1. Create a service with 2 pods running nginx
2. Create an ingress out of this service
3. From another Pod do a wget on the ingress Cluster ip
Validate that Ingress get a IP from Public FIP pool which might/might not be accessible.
Validate that service and its loadbalancing work
2025-07-23 13:11:20,535 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AgentXmppConnectionStatusReq?
2025-07-23 13:11:20,542 - DEBUG - Nothing to compare xmpp stats {'10.0.0.65': {'10.20.0.254': '0'}} with
2025-07-23 13:11:20,542 - INFO - Initial checks done. Running the testcase now
2025-07-23 13:11:20,542 - INFO -
2025-07-23 13:11:20,546 - INFO - Namespace default already exists
2025-07-23 13:11:20,547 - DEBUG - [10.0.0.65]: Running cmd : docker exec --privileged -it kubemanager_k8s_kubemanager_1 /bin/bash -c 'grep "^[ ]*cluster_project" /etc/contrail/contrail-kubernetes.conf'
2025-07-23 13:11:20,727 - DEBUG - Output : cluster_project={}
2025-07-23 13:11:20,775 - INFO - Project default-domain:k8s-default for Namespace default is seen in contrail-api
2025-07-23 13:11:20,775 - DEBUG - Project uuid in Contrail is 11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:11:20,775 - DEBUG - [10.0.0.65]: Running cmd : docker exec --privileged -it kubemanager_k8s_kubemanager_1 /bin/bash -c 'netstat -antp | grep :8108 | grep LISTEN'
2025-07-23 13:11:20,944 - DEBUG - Output : tcp 0 0 0.0.0.0:8108 0.0.0.0:* LISTEN 1/python3
2025-07-23 13:11:20,944 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_NamespaceDatabaseList?namespace_uuid=bbe472b2-68bc-43e6-8a1f-6f7c454fca51
2025-07-23 13:11:20,950 - INFO - Namespace default with uuid bbe472b2-68bc-43e6-8a1f-6f7c454fca51 found in kube manager
2025-07-23 13:11:20,950 - INFO - Namespace default verification passed
2025-07-23 13:11:20,963 - DEBUG - Service ctest-nginx-svc-83883770 not present
2025-07-23 13:11:20,963 - INFO - Creating service ctest-nginx-svc-83883770
2025-07-23 13:11:20,978 - INFO - Created Service ctest-nginx-svc-83883770
2025-07-23 13:11:20,983 - DEBUG - Pod ctest-nginx-pod-01598076 not present
2025-07-23 13:11:20,983 - INFO - Creating Pod ctest-nginx-pod-01598076
2025-07-23 13:11:21,024 - DEBUG - Pod : ctest-nginx-pod-01598076 UUID is ffd693b2-3f39-4d1d-a549-907809221bc8
2025-07-23 13:11:21,027 - DEBUG - Pod ctest-nginx-pod-15618502 not present
2025-07-23 13:11:21,027 - INFO - Creating Pod ctest-nginx-pod-15618502
2025-07-23 13:11:21,049 - DEBUG - Pod : ctest-nginx-pod-15618502 UUID is 51d5c577-1a42-46b0-bfe9-e22259084143
2025-07-23 13:11:21,232 - INFO - Created VN __public__, UUID :ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,395 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-23 13:11:21,404 - DEBUG - Requesting: http://10.0.0.65:8082/domain/e260b05f-7cd0-4026-84e3-1f5b767fbd4c
2025-07-23 13:11:21,420 - DEBUG - Requesting: http://10.0.0.65:8082/project/11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:11:21,475 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,487 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,498 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:11:21,506 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:11:21,513 - DEBUG - Requesting: http://10.0.0.65:8082/route-target/00a888b9-6f03-41a6-8f9c-e405d52f3812
2025-07-23 13:11:21,523 - DEBUG - Route Targets: ['target:64512:8000007']
2025-07-23 13:11:21,523 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,533 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:11:21,552 - INFO - Verified VN network id 15 for VN ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,552 - INFO - Verifications in API Server for VN __public__ passed
2025-07-23 13:11:21,552 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,564 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:11:21,576 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:11:21,585 - DEBUG - Requesting: http://10.0.0.65:8082/route-target/00a888b9-6f03-41a6-8f9c-e405d52f3812
2025-07-23 13:11:21,592 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:k8s-default:__public__
2025-07-23 13:11:21,600 - DEBUG - Control-node 10.0.0.65 : VN object is : {'node_name': 'virtual-network:default-domain:k8s-default:__public__', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'cloud-admin', 'owner-access': '7', 'group': 'cloud-admin-group', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18438677150194812365', 'uuid-lslong': '13625993013878597322'}, 'enable': 'true', 'created': '2025-07-23T13:11:21', 'last-modified': '2025-07-23T13:11:21', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.294350'}
2025-07-23 13:11:21,600 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_ShowRoutingInstanceReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:11:21,612 - DEBUG - Route Targets: ['target:64512:8000007']
2025-07-23 13:11:21,612 - INFO - On all control nodes, Config, RI and RT verification for VN __public__ passed
2025-07-23 13:11:21,612 - DEBUG - ====Verifying policy data for __public__ in API_Server ======
2025-07-23 13:11:21,612 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-23 13:11:21,617 - DEBUG - Requesting: http://10.0.0.65:8082/domain/e260b05f-7cd0-4026-84e3-1f5b767fbd4c
2025-07-23 13:11:21,626 - DEBUG - Requesting: http://10.0.0.65:8082/project/11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:11:21,676 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,690 - DEBUG - =>VN __public__ has no policy to be verified
2025-07-23 13:11:21,690 - DEBUG - Verifying the vn in opserver
2025-07-23 13:11:21,690 - DEBUG - Verifying the default-domain:k8s-default:__public__ virtual network link through opserver 10.0.0.65
2025-07-23 13:11:21,690 - DEBUG - Requesting: http://10.0.0.65:8081/analytics/uves/virtual-networks
2025-07-23 13:11:21,695 - DEBUG - vn link and name as {'name': 'default-domain:k8s-default:__public__', 'href': 'http://10.0.0.65:8081/analytics/uves/virtual-network/default-domain:k8s-default:__public__?flat'}
2025-07-23 13:11:21,695 - INFO - Validated that VN default-domain:k8s-default:__public__ is found in opserver
2025-07-23 13:11:21,696 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VrfListReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:11:21,705 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VrfListReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:11:21,710 - DEBUG - Do not have enough data to verify VN in agent
2025-07-23 13:11:21,710 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VrfListReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:11:21,716 - DEBUG - VRF ids for VN __public__: {}
2025-07-23 13:11:21,778 - INFO - Creating Floating IP pool __fip_pool_public__ in API Server
2025-07-23 13:11:21,874 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-23 13:11:21,881 - DEBUG - Requesting: http://10.0.0.65:8082/domain/e260b05f-7cd0-4026-84e3-1f5b767fbd4c
2025-07-23 13:11:21,889 - DEBUG - Requesting: http://10.0.0.65:8082/project/11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:11:21,932 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:21,941 - DEBUG - Requesting: http://10.0.0.65:8082/floating-ip-pool/009cd417-f253-4666-b069-b1c312348a3a
2025-07-23 13:11:21,949 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-23 13:11:21,954 - DEBUG - Requesting: http://10.0.0.65:8082/domain/e260b05f-7cd0-4026-84e3-1f5b767fbd4c
2025-07-23 13:11:21,960 - DEBUG - Requesting: http://10.0.0.65:8082/project/11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:11:22,005 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-network/ffe3572d-0179-45cd-bd19-4073d83026ca
2025-07-23 13:11:22,017 - DEBUG - FIP Pool __fip_pool_public__ found in API Server
2025-07-23 13:11:22,017 - INFO - Verification for FIP pool __fip_pool_public__ in API Server passed
2025-07-23 13:11:22,024 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_IFMapTableShowReq?table_name=floating-ip-pool&search_string=floating-ip-pool:default-domain:k8s-default:__public__:__fip_pool_public__
2025-07-23 13:11:22,030 - DEBUG - Control-node Ifmap-view has FIP pool __fip_pool_public__ information
2025-07-23 13:11:22,030 - INFO - Verification for FIP pool __fip_pool_public__ in Control-node passed
2025-07-23 13:11:22,033 - DEBUG - Ingress ctest-nginx-ingress-87252057 not present
2025-07-23 13:11:22,033 - INFO - Creating Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:22,040 - INFO - Created Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:22,044 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:25,052 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:28,063 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:31,070 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:34,078 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:37,091 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:40,103 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:43,109 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:46,115 - DEBUG - Cluster IP not yet seen for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:49,121 - DEBUG - For Ingress ctest-nginx-ingress-87252057, Cluster IP: 10.47.255.246, External IPs ['181.38.23.252']
2025-07-23 13:11:49,121 - INFO - Verifications in k8s passed for Ingress ctest-nginx-ingress-87252057
2025-07-23 13:11:49,121 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:11:49,126 - INFO - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a found in kube manager
2025-07-23 13:11:49,126 - INFO - Ingress ctest-nginx-ingress-87252057 verification passed
2025-07-23 13:11:49,129 - DEBUG - Pod ctest-busybox-pod-47015662 not present
2025-07-23 13:11:49,129 - INFO - Creating Pod ctest-busybox-pod-47015662
2025-07-23 13:11:49,164 - DEBUG - Pod : ctest-busybox-pod-47015662 UUID is bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:11:49,174 - INFO - Pod ctest-nginx-pod-01598076 is in running state.Got IP 10.47.255.248
2025-07-23 13:11:49,236 - DEBUG - Pod ctest-nginx-pod-01598076 has vmi 8c81720a-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:11:49,236 - INFO - Verified pod ctest-nginx-pod-01598076 in contrail-api
2025-07-23 13:11:49,236 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:11:49,259 - DEBUG - VMI 8c81720a-67c6-11f0-8f9c-fa163e2f2775 is active in agent 10.0.0.65
2025-07-23 13:11:49,260 - INFO - Verified Pod ctest-nginx-pod-01598076 in agent 10.0.0.65
2025-07-23 13:11:49,260 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_VirtualMachineDatabaseList?x=ffd693b2-3f39-4d1d-a549-907809221bc8
2025-07-23 13:11:49,265 - INFO - Pod ctest-nginx-pod-01598076 with uuid ffd693b2-3f39-4d1d-a549-907809221bc8 found in kube manager
2025-07-23 13:11:49,265 - INFO - Pod ctest-nginx-pod-01598076 verification passed
2025-07-23 13:11:49,361 - DEBUG - [Pod ctest-nginx-pod-01598076] Cmd: echo ctest-nginx-pod-01598076 > /usr/share/nginx/html/index.html, Output:
2025-07-23 13:11:49,372 - INFO - Pod ctest-nginx-pod-15618502 is in running state.Got IP 10.47.255.247
2025-07-23 13:11:49,402 - DEBUG - Pod ctest-nginx-pod-15618502 has vmi 8f78415a-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:11:49,402 - INFO - Verified pod ctest-nginx-pod-15618502 in contrail-api
2025-07-23 13:11:49,402 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:11:49,414 - DEBUG - VMI 8f78415a-67c6-11f0-8f9c-fa163e2f2775 is active in agent 10.0.0.65
2025-07-23 13:11:49,415 - INFO - Verified Pod ctest-nginx-pod-15618502 in agent 10.0.0.65
2025-07-23 13:11:49,415 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_VirtualMachineDatabaseList?x=51d5c577-1a42-46b0-bfe9-e22259084143
2025-07-23 13:11:49,436 - INFO - Pod ctest-nginx-pod-15618502 with uuid 51d5c577-1a42-46b0-bfe9-e22259084143 found in kube manager
2025-07-23 13:11:49,436 - INFO - Pod ctest-nginx-pod-15618502 verification passed
2025-07-23 13:11:49,524 - DEBUG - [Pod ctest-nginx-pod-15618502] Cmd: echo ctest-nginx-pod-15618502 > /usr/share/nginx/html/index.html, Output:
2025-07-23 13:11:49,539 - DEBUG - Pod ctest-busybox-pod-47015662 not in running state.Currently in Pending
2025-07-23 13:11:54,562 - DEBUG - Pod ctest-busybox-pod-47015662 not in running state.Currently in Pending
2025-07-23 13:11:59,574 - DEBUG - Pod ctest-busybox-pod-47015662 not in running state.Currently in Pending
2025-07-23 13:12:04,582 - INFO - Pod ctest-busybox-pod-47015662 is in running state.Got IP 10.47.255.245
2025-07-23 13:12:04,600 - DEBUG - Pod ctest-busybox-pod-47015662 has vmi 9b320d28-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:12:04,600 - INFO - Verified pod ctest-busybox-pod-47015662 in contrail-api
2025-07-23 13:12:04,601 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:12:04,620 - DEBUG - VMI 9b320d28-67c6-11f0-8f9c-fa163e2f2775 is active in agent 10.0.0.65
2025-07-23 13:12:04,621 - INFO - Verified Pod ctest-busybox-pod-47015662 in agent 10.0.0.65
2025-07-23 13:12:04,621 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_VirtualMachineDatabaseList?x=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:04,630 - INFO - Pod ctest-busybox-pod-47015662 with uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b found in kube manager
2025-07-23 13:12:04,631 - INFO - Pod ctest-busybox-pod-47015662 verification passed
2025-07-23 13:12:04,695 - DEBUG - [Pod ctest-busybox-pod-47015662] Cmd: wget http://10.47.255.246:80/ -O - -T 5 -t 1 , Output: ctest-nginx-pod-01598076
Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
2025-07-23 13:12:04,695 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd wget http://10.47.255.246:80/ -O - -T 5 -t 1 passed
2025-07-23 13:12:04,695 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd output: ctest-nginx-pod-01598076
Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
2025-07-23 13:12:04,764 - DEBUG - [Pod ctest-busybox-pod-47015662] Cmd: wget http://10.47.255.246:80/ -O - -T 5 -t 1 , Output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,764 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd wget http://10.47.255.246:80/ -O - -T 5 -t 1 passed
2025-07-23 13:12:04,764 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,832 - DEBUG - [Pod ctest-busybox-pod-47015662] Cmd: wget http://10.47.255.246:80/ -O - -T 5 -t 1 , Output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,832 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd wget http://10.47.255.246:80/ -O - -T 5 -t 1 passed
2025-07-23 13:12:04,832 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,900 - DEBUG - [Pod ctest-busybox-pod-47015662] Cmd: wget http://10.47.255.246:80/ -O - -T 5 -t 1 , Output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,900 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd wget http://10.47.255.246:80/ -O - -T 5 -t 1 passed
2025-07-23 13:12:04,900 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-01598076
2025-07-23 13:12:04,982 - DEBUG - [Pod ctest-busybox-pod-47015662] Cmd: wget http://10.47.255.246:80/ -O - -T 5 -t 1 , Output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-15618502
2025-07-23 13:12:04,982 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd wget http://10.47.255.246:80/ -O - -T 5 -t 1 passed
2025-07-23 13:12:04,983 - DEBUG - [Pod Pod ctest-busybox-pod-47015662] Cmd output: Connecting to 10.47.255.246:80 (10.47.255.246:80)
writing to stdout
- 100% |********************************| 25 0:00:00 ETA
written to stdout
ctest-nginx-pod-15618502
2025-07-23 13:12:04,983 - INFO - Responses seen from all pods, lb seems fine.Hits : {'ctest-nginx-pod-01598076': 4, 'ctest-nginx-pod-15618502': 1}
2025-07-23 13:12:04,983 - WARNING - Nothing to delete parallely
2025-07-23 13:12:04,983 - INFO - Deleting pod default:ctest-busybox-pod-47015662
2025-07-23 13:12:04,994 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:05,003 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:10,004 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:10,018 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:15,019 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:15,034 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:20,035 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:20,047 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:25,048 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:25,054 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:30,055 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:30,071 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:35,072 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:35,091 - WARNING - Pod uuid bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:40,092 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b
2025-07-23 13:12:40,111 - DEBUG - Pod bd2dd09c-1d76-461c-b8ff-3f5ff5859b7b is not in agent 10.0.0.65 VM list
2025-07-23 13:12:40,112 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:9b320d28-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:12:40,140 - DEBUG - VMI 9b320d28-67c6-11f0-8f9c-fa163e2f2775 is removed from agent 10.0.0.65
2025-07-23 13:12:40,141 - INFO - Verified that pod ctest-busybox-pod-47015662 is removed in agent
2025-07-23 13:12:40,142 - INFO - Deleting Ingress : ctest-nginx-ingress-87252057
2025-07-23 13:12:40,168 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:40,189 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:41,190 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:41,196 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:42,197 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:42,212 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:43,213 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:43,228 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:44,229 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:44,235 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:45,235 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:45,243 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:46,244 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:46,251 - ERROR - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a still found in kube manager
2025-07-23 13:12:47,252 - DEBUG - Requesting: http://10.0.0.65:8108/Snh_LoadbalancerDatabaseList?x=ff005776-aafd-42fe-8202-d734cf8c0e4a
2025-07-23 13:12:47,260 - INFO - Ingress ctest-nginx-ingress-87252057 with uuid ff005776-aafd-42fe-8202-d734cf8c0e4a deleted successfully from kube manager
2025-07-23 13:12:47,260 - INFO - Verifications on Ingress %s cleanup passed
2025-07-23 13:12:47,260 - INFO - Deleting the FIP pool __fip_pool_public__
2025-07-23 13:12:47,376 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_IFMapTableShowReq?table_name=floating-ip-pool&search_string=floating-ip-pool:default-domain:k8s-default:__public__:__fip_pool_public__
2025-07-23 13:12:47,384 - DEBUG - Control-node Ifmap-view does not have FIP pool __fip_pool_public__ information
2025-07-23 13:12:47,384 - INFO - Deleting VN __public__
2025-07-23 13:12:47,569 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/cad51338-ffd3-4291-9ca1-c97efb825251
2025-07-23 13:12:47,580 - DEBUG - Response Code: 404
2025-07-23 13:12:47,580 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-23 13:12:47,598 - DEBUG - Requesting: http://10.0.0.65:8082/domain/e260b05f-7cd0-4026-84e3-1f5b767fbd4c
2025-07-23 13:12:47,625 - DEBUG - Requesting: http://10.0.0.65:8082/project/11383923-2f93-4b2c-b4b3-a6da7905dd4d
2025-07-23 13:12:47,709 - INFO - Validated that VN __public__ is not found in API Server
2025-07-23 13:12:47,709 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VnListReq?name=default-domain:k8s-default:__public__
2025-07-23 13:12:47,725 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VrfListReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:12:47,734 - DEBUG - VN __public__ is not present in Agent 10.0.0.65
2025-07-23 13:12:47,734 - INFO - Validated that VN __public__ is not in any agent
2025-07-23 13:12:47,734 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VrfListReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:12:47,741 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_ShowRoutingInstanceReq?name=default-domain:k8s-default:__public__:__public__
2025-07-23 13:12:47,747 - DEBUG - Requesting: http://10.0.0.65:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:k8s-default:__public__
2025-07-23 13:12:47,755 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN __public__ info
2025-07-23 13:12:47,755 - INFO - Deleting pod default:ctest-nginx-pod-15618502
2025-07-23 13:12:47,775 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=51d5c577-1a42-46b0-bfe9-e22259084143
2025-07-23 13:12:47,792 - WARNING - Pod uuid 51d5c577-1a42-46b0-bfe9-e22259084143 is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:52,793 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=51d5c577-1a42-46b0-bfe9-e22259084143
2025-07-23 13:12:52,804 - DEBUG - Pod 51d5c577-1a42-46b0-bfe9-e22259084143 is not in agent 10.0.0.65 VM list
2025-07-23 13:12:52,804 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:8f78415a-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:12:52,812 - DEBUG - VMI 8f78415a-67c6-11f0-8f9c-fa163e2f2775 is removed from agent 10.0.0.65
2025-07-23 13:12:52,812 - INFO - Verified that pod ctest-nginx-pod-15618502 is removed in agent
2025-07-23 13:12:52,813 - INFO - Deleting pod default:ctest-nginx-pod-01598076
2025-07-23 13:12:52,827 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=ffd693b2-3f39-4d1d-a549-907809221bc8
2025-07-23 13:12:52,850 - WARNING - Pod uuid ffd693b2-3f39-4d1d-a549-907809221bc8 is still seen in agent 10.0.0.65 VM list
2025-07-23 13:12:57,855 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=ffd693b2-3f39-4d1d-a549-907809221bc8
2025-07-23 13:12:57,874 - DEBUG - Pod ffd693b2-3f39-4d1d-a549-907809221bc8 is not in agent 10.0.0.65 VM list
2025-07-23 13:12:57,875 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:8c81720a-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:12:57,897 - DEBUG - VMI 8c81720a-67c6-11f0-8f9c-fa163e2f2775 is removed from agent 10.0.0.65
2025-07-23 13:12:57,898 - INFO - Verified that pod ctest-nginx-pod-01598076 is removed in agent
2025-07-23 13:12:57,898 - INFO - Deleting service : ctest-nginx-svc-83883770
2025-07-23 13:12:58,664 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AgentXmppConnectionStatusReq?
2025-07-23 13:12:58,672 - DEBUG - No XMPP flaps were noticed during the test
2025-07-23 13:12:58,672 - INFO - END TEST : test_ingress_ip_assignment : PASSED[0:01:38]
2025-07-23 13:12:58,672 - INFO - --------------------------------------------------------------------------------
2025-07-23 13:13:05,166 - DEBUG - [10.0.0.65]: Running cmd : docker exec --privileged -it kubemanager_k8s_kubemanager_1 /bin/bash -c 'grep "^[ ]*cluster_project" /etc/contrail/contrail-kubernetes.conf'
2025-07-23 13:13:05,391 - DEBUG - Output : cluster_project={}
2025-07-23 13:13:05,459 - DEBUG - [10.0.0.65]: Running cmd : docker exec --privileged -it kubemanager_k8s_kubemanager_1 /bin/bash -c 'netstat -antp | grep :8108 | grep LISTEN'
2025-07-23 13:13:05,705 - DEBUG - Output : tcp 0 0 0.0.0.0:8108 0.0.0.0:* LISTEN 1/python3
2025-07-23 13:13:05,714 - DEBUG - [10.0.0.65]: Running cmd : docker exec --privileged -it kubemanager_k8s_kubemanager_1 /bin/bash -c 'grep "^[ ]*cluster_project" /etc/contrail/contrail-kubernetes.conf'
2025-07-23 13:13:05,950 - DEBUG - Output : cluster_project={}
2025-07-23 13:13:46,256 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:13:46,346 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:13:51,433 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:13:51,522 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:14:11,633 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:14:21,775 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:14:21,857 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:14:21,910 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,
2025-07-23 13:14:22,693 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AgentXmppConnectionStatusReq?
2025-07-23 13:14:30,162 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_ApplicationPolicySetReq?
2025-07-23 13:14:30,174 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AclReq?
2025-07-23 13:14:30,216 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AclReq?
2025-07-23 13:14:32,257 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AclReq?
2025-07-23 13:14:34,342 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AclReq?
2025-07-23 13:17:37,083 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_AgentXmppConnectionStatusReq?
2025-07-23 13:17:37,218 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=07fee6c9-9197-4c40-9461-376cb7f1b814
2025-07-23 13:17:37,251 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:17:37,257 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:17:37,265 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=ce460a11-a8fa-4904-8617-b724469aca1a
2025-07-23 13:17:37,272 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=f52f9004-64c5-4216-af78-cf232618062c
2025-07-23 13:17:37,298 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=3b5cf88d-94fa-4332-9798-e044a0ae939a
2025-07-23 13:17:37,373 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:17:37,384 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:17:42,493 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:17:42,496 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=ce460a11-a8fa-4904-8617-b724469aca1a
2025-07-23 13:17:42,497 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:17:42,498 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:17:42,500 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=07fee6c9-9197-4c40-9461-376cb7f1b814
2025-07-23 13:17:42,502 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:17:42,506 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=3b5cf88d-94fa-4332-9798-e044a0ae939a
2025-07-23 13:17:42,508 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=f52f9004-64c5-4216-af78-cf232618062c
2025-07-23 13:17:42,533 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:d1cdf324-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:17:42,537 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:d9a09b38-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:17:47,537 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:17:47,544 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:17:47,550 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=07fee6c9-9197-4c40-9461-376cb7f1b814
2025-07-23 13:17:47,554 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:17:47,558 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=3b5cf88d-94fa-4332-9798-e044a0ae939a
2025-07-23 13:17:47,562 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:17:52,623 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=3b5cf88d-94fa-4332-9798-e044a0ae939a
2025-07-23 13:17:52,634 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:17:52,638 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:17:52,642 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:17:52,646 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:17:52,651 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=07fee6c9-9197-4c40-9461-376cb7f1b814
2025-07-23 13:17:52,715 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:d02d1608-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:17:57,715 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:17:57,723 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=3b5cf88d-94fa-4332-9798-e044a0ae939a
2025-07-23 13:17:57,729 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:17:57,738 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:17:57,742 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:17:57,805 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:d61bce56-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:18:02,753 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:18:02,803 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:18:02,805 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:18:02,813 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:18:07,763 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:18:07,817 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:18:07,819 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:18:07,822 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:18:12,788 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:18:12,833 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=5f42223c-600f-4223-99a0-722d76ec68fa
2025-07-23 13:18:12,840 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=c812f7ce-b314-4f7e-b8c0-4a24b0d00b43
2025-07-23 13:18:12,855 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:18:12,915 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:e3bcb7aa-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:18:12,926 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:dc966b56-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:18:17,821 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=fbea73e8-d0b4-4628-8049-6576329cc149
2025-07-23 13:18:17,843 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:e0d58df0-67c6-11f0-8f9c-fa163e2f2775
2025-07-23 13:18:17,926 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_VmListReq?uuid=29b4bf00-6e20-4984-908c-8fd5030cd43e
2025-07-23 13:18:17,949 - DEBUG - Requesting: http://10.0.0.65:8085/Snh_PageReq?x=begin:-1,end:-1,table:db.interface.0,uuid:e6a2f772-67c6-11f0-8f9c-fa163e2f2775