2026-10-31 12:54:18,275 - INFO - Domain Default found not creating
2026-10-31 12:54:18,456 - INFO - Project ctest-AnalyticsBasicTestSanity-26498340 not found, creating it
2026-10-31 12:54:18,954 - INFO - Created Project:ctest-AnalyticsBasicTestSanity-26498340, ID : a4c3ee5b-899e-40d8-8081-2ef7910df1f1
2026-10-31 12:54:20,960 - INFO - ================================================================================
2026-10-31 12:54:20,960 - INFO - STARTING TEST : test_verify_object_logs
2026-10-31 12:54:20,960 - INFO - TEST DESCRIPTION :
Description: Test to validate object logs
1.Create vn/vm and verify object log tables updated with
those vn, vm and routing-instance - fails otherwise
Maintainer: sandipd@juniper.net
2026-10-31 12:54:21,089 - DEBUG - Nothing to compare xmpp stats {'10.0.0.185': {'10.20.0.25': '0'}} with
2026-10-31 12:54:21,089 - INFO - Initial checks done. Running the testcase now
2026-10-31 12:54:21,090 - INFO -
2026-10-31 12:54:21,856 - DEBUG - Response for create_network : {'network': {'id': 'c238d793-16ad-4611-895c-aa4fabfb39a9', 'name': 'ctest-vn22-88978625', 'tenant_id': 'a4c3ee5b899e40d880812ef7910df1f1', 'project_id': 'a4c3ee5b899e40d880812ef7910df1f1', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'tags': [], 'subnets': [], 'fq_name': ['default-domain', 'ctest-AnalyticsBasicTestSanity-26498340', 'ctest-vn22-88978625'], 'port_security_enabled': True, 'description': ''}}
2026-10-31 12:54:22,054 - DEBUG - Response for create_subnet : {'subnet': {'id': 'f9842504-3a62-4052-aa69-ba29d53e82b4', 'name': '', 'tenant_id': 'a4c3ee5b899e40d880812ef7910df1f1', 'network_id': 'c238d793-16ad-4611-895c-aa4fabfb39a9', 'ip_version': 4, 'cidr': '111.39.246.0/26', 'allocation_pools': [{'start': '111.39.246.2', 'end': '111.39.246.62'}], 'gateway_ip': '111.39.246.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '111.39.246.2', 'tags': [], 'project_id': 'a4c3ee5b899e40d880812ef7910df1f1'}}
2026-10-31 12:54:22,070 - INFO - Created VN ctest-vn22-88978625
2026-10-31 12:54:22,123 - DEBUG - VN ctest-vn22-88978625 UUID is c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,220 - DEBUG - Requesting: http://10.0.0.185:8082/domains
2026-10-31 12:54:22,582 - DEBUG - Requesting: http://10.0.0.185:8082/domains
2026-10-31 12:54:22,609 - DEBUG - Requesting: http://10.0.0.185:8082/domain/9fb69766-2f98-4b3a-b7eb-0a3b95e3d4e1
2026-10-31 12:54:22,626 - DEBUG - Requesting: http://10.0.0.185:8082/project/a4c3ee5b-899e-40d8-8081-2ef7910df1f1
2026-10-31 12:54:22,703 - DEBUG - Requesting: http://10.0.0.185:8082/virtual-network/c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,713 - DEBUG - Requesting: http://10.0.0.185:8082/virtual-network/c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,722 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:54:22,728 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:54:22,735 - DEBUG - Requesting: http://10.0.0.185:8082/route-target/28c8e91a-0016-4be8-a905-a07570d870b5
2026-10-31 12:54:22,741 - DEBUG - Route Targets: ['target:64512:8000004']
2026-10-31 12:54:22,741 - DEBUG - Requesting: http://10.0.0.185:8082/virtual-network/c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,749 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:54:22,762 - INFO - Verified VN network id 5 for VN c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,762 - INFO - Verifications in API Server for VN ctest-vn22-88978625 passed
2026-10-31 12:54:22,762 - DEBUG - Requesting: http://10.0.0.185:8082/virtual-network/c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,772 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:54:22,778 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:54:22,784 - DEBUG - Requesting: http://10.0.0.185:8082/route-target/28c8e91a-0016-4be8-a905-a07570d870b5
2026-10-31 12:54:22,790 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
2026-10-31 12:54:22,797 - DEBUG - Control-node 10.0.0.185 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsBasicTestSanity-26498340', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13995172868794435089', 'uuid-lslong': '9897973340218014121'}, 'enable': 'true', 'created': '2026-10-31T12:54:21', 'last-modified': '2026-10-31T12:54:22', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.782378'}
2026-10-31 12:54:22,797 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
2026-10-31 12:54:22,804 - DEBUG - Route Targets: ['target:64512:8000004']
2026-10-31 12:54:22,804 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-vn22-88978625 passed
2026-10-31 12:54:22,804 - DEBUG - ====Verifying policy data for ctest-vn22-88978625 in API_Server ======
2026-10-31 12:54:22,804 - DEBUG - Requesting: http://10.0.0.185:8082/domains
2026-10-31 12:54:22,810 - DEBUG - Requesting: http://10.0.0.185:8082/domain/9fb69766-2f98-4b3a-b7eb-0a3b95e3d4e1
2026-10-31 12:54:22,820 - DEBUG - Requesting: http://10.0.0.185:8082/project/a4c3ee5b-899e-40d8-8081-2ef7910df1f1
2026-10-31 12:54:22,907 - DEBUG - Requesting: http://10.0.0.185:8082/virtual-network/c238d793-16ad-4611-895c-aa4fabfb39a9
2026-10-31 12:54:22,917 - DEBUG - =>VN ctest-vn22-88978625 has no policy to be verified
2026-10-31 12:54:22,917 - DEBUG - Verifying the vn in opserver
2026-10-31 12:54:22,917 - DEBUG - Verifying the default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625 virtual network link through opserver 10.0.0.185
2026-10-31 12:54:22,917 - DEBUG - Requesting: http://10.0.0.185:8081/analytics/uves/virtual-networks
2026-10-31 12:54:23,281 - DEBUG - Requesting: http://10.0.0.185:8081/analytics/uves/virtual-networks
2026-10-31 12:54:23,328 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'href': 'http://10.0.0.185:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625?flat'}
2026-10-31 12:54:23,328 - INFO - Validated that VN default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625 is found in opserver
2026-10-31 12:54:23,340 - DEBUG - Do not have enough data to verify VN in agent
2026-10-31 12:54:23,345 - DEBUG - VRF ids for VN ctest-vn22-88978625: {}
2026-10-31 12:54:23,433 - DEBUG - Services list from nova: [, , ]
2026-10-31 12:54:23,620 - DEBUG - Image by name cirros not found
2026-10-31 12:54:23,621 - DEBUG - Installing image cirros
2026-10-31 12:54:23,621 - DEBUG - Image info {'name': 'cirros-0.3.0-x86_64-disk.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'cirros', 'password': 'cubswin:)', 'type': 'os', 'flavor': 'contrail_flavor_tiny', 'params': '--container-format bare --disk-format vmdk --property vmware_disktype="sparse" --property vmware_adaptertype="ide" --property hw_scsi_model=virtio-scsi --property hw_disk_bus_model=virtio-scsi --property hw_disk_bus=virtio', 'name_docker': 'phusion-baseimage-enablesshd'}
2026-10-31 12:54:23,621 - DEBUG - Image build path http://nexus.opensdn.io/repository///images/converts//cirros-0.3.0-x86_64-disk.vmdk.gz
2026-10-31 12:54:23,621 - DEBUG - Download image from web http://nexus.opensdn.io/repository///images/converts//cirros-0.3.0-x86_64-disk.vmdk.gz
2026-10-31 12:54:23,633 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: wget -nv http://nexus.opensdn.io/repository///images/converts//cirros-0.3.0-x86_64-disk.vmdk.gz -O /contrail-test/images/cirros-0.3.0-x86_64-disk.vmdk.gz
2026-10-31 12:54:23,823 - DEBUG - Image has been downloaded to /contrail-test/images/cirros-0.3.0-x86_64-disk.vmdk.gz
2026-10-31 12:54:23,824 - DEBUG - Unzip image
2026-10-31 12:54:23,824 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/cirros-0.3.0-x86_64-disk.vmdk.gz
2026-10-31 12:54:23,956 - DEBUG - Try to create image in user context
2026-10-31 12:54:24,216 - DEBUG - Image has been created in user context
2026-10-31 12:54:24,216 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: rm -f /contrail-test/images/cirros-0.3.0-x86_64-disk.vmdk
2026-10-31 12:54:24,230 - DEBUG - Downloaded image has been removed
2026-10-31 12:54:24,251 - DEBUG - Uploaded image status = active
2026-10-31 12:54:27,163 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-6453-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-6453-1)
2026-10-31 12:54:27,204 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:32,273 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:37,347 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:42,423 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:47,498 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:52,567 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-10-31 12:54:57,639 - DEBUG - VM is in ACTIVE state now
2026-10-31 12:54:57,639 - DEBUG - Verifying ObjectVNTable for vn default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625 on analytics node 10.0.0.185
2026-10-31 12:54:57,642 - DEBUG - Posting: http://10.0.0.185:8081/analytics/query, payload {'table': 'ObjectVNTable', 'start_time': 1793451261090252, 'end_time': 1793451297642002, 'select_fields': ['ObjectId', 'Source', 'ObjectLog', 'SystemLog', 'Messagetype', 'ModuleId', 'MessageTS'], 'where': [[{'name': 'ObjectId', 'value': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'op': 1, 'value2': None}]]}
2026-10-31 12:54:58,673 - DEBUG - Query output : [{'MessageTS': 1793451261783439, 'Messagetype': 'ContrailConfigTrace', 'ModuleId': 'contrail-api', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625false', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451261791578, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451261792102, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451261822176, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625target:10.20.0.25:6target:64512:7999999
cn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1239', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261822216, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625Addinetcn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1720', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261822332, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625Addinet6cn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1720', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261822406, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625Adderm-vpncn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1720', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261822473, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625Adde-vpncn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1720', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261822537, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625Addinet-mvpncn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1720', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261875893, 'Messagetype': 'RoutingInstanceCollector', 'ModuleId': 'contrail-control', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-8897862510.20.0.25:6target:64512:8000004
target:64512:8000004
cn-jenkins-deploy-platform-ansible-os-6453-1controller/src/bgp/routing-instance/routing_instance.cc1392', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451261911858, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451261912314, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451262013058, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451262013209, 'Messagetype': 'ContrailConfigTrace', 'ModuleId': 'contrail-api', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625false', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451262013467, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272393728, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272394027, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272434174, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272434420, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272495981, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451272496268, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451273045421, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451273045736, 'Messagetype': 'UveVirtualNetworkConfigTrace', 'ModuleId': 'contrail-schema', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
0', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451278355393, 'Messagetype': 'VnObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'Addition c238d793-16ad-4611-895c-aa4fabfb39a9default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-8897862500000000-0000-0000-0000-000000000000111.39.246.026111.39.246.1default-domain:default-project:default-network-ipamtrue111.39.246.2true
truetruetruefalse0controller/src/vnsw/agent/oper/vn.cc1408', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451278365698, 'Messagetype': 'VnObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'Modification c238d793-16ad-4611-895c-aa4fabfb39a9default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-8897862500000000-0000-0000-0000-000000000000default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625111.39.246.026111.39.246.1default-domain:default-project:default-network-ipamtrue111.39.246.2true
truetruetruefalse5controller/src/vnsw/agent/oper/vn.cc1408', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451281572617, 'Messagetype': 'UveVirtualNetworkAgentTrace', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-889786250default-domain:ctest-AnalyticsBasicTestSanity-26498340:b95ab2f5-1b2a-49f2-b81b-7a2058340547
f0e12a09-f741-4c18-b5b9-e03e41fde7d7
', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451281578094, 'Messagetype': 'UveVirtualNetworkAgentTrace', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625', 'ObjectLog': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625000default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-889786250000000000000000000000000
00', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}]
2026-10-31 12:54:58,673 - DEBUG - Verifying ObjectVMTable for vm f0e12a09-f741-4c18-b5b9-e03e41fde7d7 on analytics node 10.0.0.185
2026-10-31 12:54:58,674 - DEBUG - Posting: http://10.0.0.185:8081/analytics/query, payload {'table': 'ObjectVMTable', 'start_time': 1793451261090252, 'end_time': 1793451298674047, 'select_fields': ['ObjectId', 'Source', 'ObjectLog', 'SystemLog', 'ModuleId', 'Messagetype', 'MessageTS'], 'where': [[{'name': 'ObjectId', 'value': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'op': 1, 'value2': None}]]}
2026-10-31 12:54:59,706 - DEBUG - Query output : [{'MessageTS': 1793451272306337, 'Messagetype': 'ContrailConfigTrace', 'ModuleId': 'contrail-api', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7false', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}, {'MessageTS': 1793451278317504, 'Messagetype': 'VmObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'Addition f0e12a09-f741-4c18-b5b9-e03e41fde7d70controller/src/vnsw/agent/oper/vm.cc141', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451278330155, 'Messagetype': 'VmObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'Modification f0e12a09-f741-4c18-b5b9-e03e41fde7d71controller/src/vnsw/agent/oper/vm.cc141', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451281572653, 'Messagetype': 'UveVirtualMachineAgentTrace', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7default-domain:ctest-AnalyticsBasicTestSanity-26498340:b95ab2f5-1b2a-49f2-b81b-7a2058340547
cn-jenkins-deploy-platform-ansible-os-6453-1f0e12a09-f741-4c18-b5b9-e03e41fde7d7ctest-AnalyticsBasicTestSanity-26498340-52797683', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}]
2026-10-31 12:54:59,706 - DEBUG - Verifying ObjectRoutingInstance for RI default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625 on analytics node 10.0.0.185
2026-10-31 12:54:59,707 - DEBUG - Posting: http://10.0.0.185:8081/analytics/query, payload {'table': 'ObjectRoutingInstance', 'start_time': 1793451261090252, 'end_time': 1793451299707002, 'select_fields': ['ObjectId', 'Source', 'ObjectLog', 'SystemLog', 'ModuleId', 'Messagetype', 'MessageTS'], 'where': [[{'name': 'ObjectId', 'value': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625', 'op': 1, 'value2': None}]]}
2026-10-31 12:55:00,731 - DEBUG - Query output : [{'MessageTS': 1793451278355471, 'Messagetype': 'VrfObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625', 'ObjectLog': 'Addition default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-889786252controller/src/vnsw/agent/oper/vrf.cc414', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}]
2026-10-31 12:55:00,731 - DEBUG - Verifying ObjectVMTable for vm f0e12a09-f741-4c18-b5b9-e03e41fde7d7 on analytics node 10.0.0.185
2026-10-31 12:55:00,732 - DEBUG - Posting: http://10.0.0.185:8081/analytics/query, payload {'table': 'ObjectVMTable', 'start_time': 1793451261090252, 'end_time': 1793451300731998, 'select_fields': ['ObjectId', 'Source', 'ObjectLog', 'SystemLog', 'ModuleId', 'Messagetype', 'MessageTS'], 'where': [[{'name': 'ObjectId', 'value': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'op': 1, 'value2': None}]]}
2026-10-31 12:55:01,761 - DEBUG - Query output : [{'MessageTS': 1793451278317504, 'Messagetype': 'VmObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'Addition f0e12a09-f741-4c18-b5b9-e03e41fde7d70controller/src/vnsw/agent/oper/vm.cc141', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451278330155, 'Messagetype': 'VmObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'Modification f0e12a09-f741-4c18-b5b9-e03e41fde7d71controller/src/vnsw/agent/oper/vm.cc141', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451281572653, 'Messagetype': 'UveVirtualMachineAgentTrace', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7default-domain:ctest-AnalyticsBasicTestSanity-26498340:b95ab2f5-1b2a-49f2-b81b-7a2058340547
cn-jenkins-deploy-platform-ansible-os-6453-1f0e12a09-f741-4c18-b5b9-e03e41fde7d7ctest-AnalyticsBasicTestSanity-26498340-52797683', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}, {'MessageTS': 1793451272306337, 'Messagetype': 'ContrailConfigTrace', 'ModuleId': 'contrail-api', 'ObjectId': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7', 'ObjectLog': 'f0e12a09-f741-4c18-b5b9-e03e41fde7d7false', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1.', 'SystemLog': None}]
2026-10-31 12:55:01,761 - DEBUG - Verifying ObjectRoutingInstance for RI default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625 on analytics node 10.0.0.185
2026-10-31 12:55:01,761 - DEBUG - Posting: http://10.0.0.185:8081/analytics/query, payload {'table': 'ObjectRoutingInstance', 'start_time': 1793451261090252, 'end_time': 1793451301761402, 'select_fields': ['ObjectId', 'Source', 'ObjectLog', 'SystemLog', 'ModuleId', 'Messagetype', 'MessageTS'], 'where': [[{'name': 'ObjectId', 'value': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625', 'op': 1, 'value2': None}]]}
2026-10-31 12:55:02,780 - DEBUG - Query output : [{'MessageTS': 1793451278355471, 'Messagetype': 'VrfObjectLog', 'ModuleId': 'contrail-vrouter-agent', 'ObjectId': 'default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625', 'ObjectLog': 'Addition default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-889786252controller/src/vnsw/agent/oper/vrf.cc414', 'Source': 'cn-jenkins-deploy-platform-ansible-os-6453-1', 'SystemLog': None}]
2026-10-31 12:55:02,780 - INFO - Validated ObjectVNTable, ObjectRoutingInstance, ObjectVMTable logs
2026-10-31 12:55:02,781 - INFO - Deleting VM ctest-AnalyticsBasicTestSanity-26498340-52797683
2026-10-31 12:55:02,985 - INFO - Deleting VN ctest-vn22-88978625
2026-10-31 12:55:03,017 - DEBUG - VN c238d793-16ad-4611-895c-aa4fabfb39a9 still in use: Unable to complete operation on network c238d793-16ad-4611-895c-aa4fabfb39a9. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-cd6b393d-baaf-4dec-9d9b-562c8efa19ee']
2026-10-31 12:55:03,017 - WARNING - Deleting VN ctest-vn22-88978625 failed..Will retry
2026-10-31 12:55:05,051 - DEBUG - VN c238d793-16ad-4611-895c-aa4fabfb39a9 still in use: Unable to complete operation on network c238d793-16ad-4611-895c-aa4fabfb39a9. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-d33a1416-764c-4059-bfd8-01f9ea056e84']
2026-10-31 12:55:05,051 - WARNING - Deleting VN ctest-vn22-88978625 failed..Will retry
2026-10-31 12:55:07,238 - DEBUG - Response for deleting network ()
2026-10-31 12:55:07,238 - DEBUG - Requesting: http://10.0.0.185:8082/routing-instance/4f23cf88-30ef-4a93-90e5-285d6fd4e40f
2026-10-31 12:55:07,244 - DEBUG - Response Code: 404
2026-10-31 12:55:07,244 - DEBUG - Requesting: http://10.0.0.185:8082/domains
2026-10-31 12:55:07,251 - DEBUG - Requesting: http://10.0.0.185:8082/domain/9fb69766-2f98-4b3a-b7eb-0a3b95e3d4e1
2026-10-31 12:55:07,261 - DEBUG - Requesting: http://10.0.0.185:8082/project/a4c3ee5b-899e-40d8-8081-2ef7910df1f1
2026-10-31 12:55:07,344 - INFO - Validated that VN ctest-vn22-88978625 is not found in API Server
2026-10-31 12:55:07,354 - DEBUG - VN ctest-vn22-88978625 is not present in Agent 10.0.0.185
2026-10-31 12:55:07,354 - INFO - Validated that VN ctest-vn22-88978625 is not in any agent
2026-10-31 12:55:07,359 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625:ctest-vn22-88978625
2026-10-31 12:55:07,364 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-AnalyticsBasicTestSanity-26498340:ctest-vn22-88978625
2026-10-31 12:55:07,368 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-vn22-88978625 info
2026-10-31 12:55:07,499 - DEBUG - No XMPP flaps were noticed during the test
2026-10-31 12:55:07,499 - INFO - END TEST : test_verify_object_logs : PASSED[0:00:47]
2026-10-31 12:55:07,499 - INFO - --------------------------------------------------------------------------------
2026-10-31 12:55:08,555 - INFO - Deleted project: ctest-AnalyticsBasicTestSanity-26498340, ID : a4c3ee5b-899e-40d8-8081-2ef7910df1f1
2026-10-31 12:55:18,990 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719
2026-10-31 12:55:18,997 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719:ctest-fvn-23244719
2026-10-31 12:55:25,395 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-vn1-13943917
2026-10-31 12:55:25,403 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-vn1-13943917:ctest-vn1-13943917
2026-10-31 12:55:27,290 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=floating-ip-pool&search_string=floating-ip-pool:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719:ctest-some-pool-44123614
2026-10-31 12:56:15,619 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRtGroupReq?x=target:64512:8000004
2026-10-31 12:56:18,862 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=floating-ip-pool&search_string=floating-ip-pool:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719:ctest-some-pool-44123614
2026-10-31 12:56:23,375 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-vn1-13943917:ctest-vn1-13943917
2026-10-31 12:56:23,379 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-vn1-13943917
2026-10-31 12:56:23,767 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719:ctest-fvn-23244719
2026-10-31 12:56:23,773 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-FloatingipBasicTestSanity-99034387:ctest-fvn-23244719
2026-10-31 13:00:15,726 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-98221544
2026-10-31 13:00:15,732 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-98221544:ctest-vn-98221544
2026-10-31 13:00:16,472 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-19495948
2026-10-31 13:00:16,477 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-19495948:ctest-vn-19495948
2026-10-31 13:00:17,249 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-19495948:ctest-vn-19495948
2026-10-31 13:00:17,257 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-19495948
2026-10-31 13:00:17,563 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-98221544:ctest-vn-98221544
2026-10-31 13:00:17,568 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyIpv4v6-65189838:ctest-vn-98221544
2026-10-31 13:00:24,077 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyNegativeIpv4v6-08487546:ctest-vn4-52099151
2026-10-31 13:00:24,084 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyNegativeIpv4v6-08487546:ctest-vn4-52099151:ctest-vn4-52099151
2026-10-31 13:00:25,199 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicyNegativeIpv4v6-08487546:ctest-vn4-52099151:ctest-vn4-52099151
2026-10-31 13:00:25,204 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicyNegativeIpv4v6-08487546:ctest-vn4-52099151
2026-10-31 13:00:32,717 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-14989490
2026-10-31 13:00:32,723 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-14989490:ctest-vn-14989490
2026-10-31 13:00:33,444 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-56691572
2026-10-31 13:00:33,452 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-56691572:ctest-vn-56691572
2026-10-31 13:01:36,851 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-56691572:ctest-vn-56691572
2026-10-31 13:01:36,855 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-56691572
2026-10-31 13:01:37,146 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-14989490:ctest-vn-14989490
2026-10-31 13:01:37,152 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicPolicy-95890430:ctest-vn-14989490
2026-10-31 13:02:48,909 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-mgmt_vn-29297761
2026-10-31 13:02:48,917 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-mgmt_vn-29297761:ctest-mgmt_vn-29297761
2026-10-31 13:02:50,244 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-left_vn-28341565
2026-10-31 13:02:50,253 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-left_vn-28341565:ctest-left_vn-28341565
2026-10-31 13:02:51,212 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-right_vn-99197669
2026-10-31 13:02:51,220 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-right_vn-99197669:ctest-right_vn-99197669
2026-10-31 13:04:55,008 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-right_vn-99197669:ctest-right_vn-99197669
2026-10-31 13:04:55,016 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-right_vn-99197669
2026-10-31 13:04:55,418 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-left_vn-28341565:ctest-left_vn-28341565
2026-10-31 13:04:55,426 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-left_vn-28341565
2026-10-31 13:04:55,827 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestSvcRegr-97793224:ctest-mgmt_vn-29297761:ctest-mgmt_vn-29297761
2026-10-31 13:04:55,835 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestSvcRegr-97793224:ctest-mgmt_vn-29297761
2026-10-31 13:05:02,848 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-DNS&search_string=virtual-DNS:default-domain:ctest-vdns1-66871943
2026-10-31 13:06:41,733 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-DNS-record&search_string=virtual-DNS-record:default-domain:ctest-vdns1-66871943:test-rec
2026-10-31 13:06:52,690 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-DNS&search_string=virtual-DNS:default-domain:ctest-vdns1-66871943
2026-10-31 13:11:29,396 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=network-ipam&search_string=network-ipam:default-domain:ctest-TestBasicVMVN-39733043:ctest-ipam-15987540
2026-10-31 13:11:30,017 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicVMVN-39733043:ctest-vn-51860914
2026-10-31 13:11:30,033 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicVMVN-39733043:ctest-vn-51860914:ctest-vn-51860914
2026-10-31 13:13:56,598 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicVMVN-39733043:ctest-vn-51860914:ctest-vn-51860914
2026-10-31 13:13:56,625 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=virtual-network&search_string=virtual-network:default-domain:ctest-TestBasicVMVN-39733043:ctest-vn-51860914
2026-10-31 13:13:56,856 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_ShowRoutingInstanceReq?name=default-domain:ctest-TestBasicVMVN-39733043:ctest-ipam-15987540:ctest-ipam-15987540
2026-10-31 13:13:56,869 - DEBUG - Requesting: http://10.0.0.185:8083/Snh_IFMapTableShowReq?table_name=network-ipam&search_string=network-ipam:default-domain:ctest-TestBasicVMVN-39733043:ctest-ipam-15987540