2026-02-02 09:17:29,650 - INFO - Domain Default found not creating 2026-02-02 09:17:29,837 - INFO - Project ctest-TestSvcRegr-28608023 not found, creating it 2026-02-02 09:17:30,303 - INFO - Created Project:ctest-TestSvcRegr-28608023, ID : 22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:31,816 - INFO - ================================================================================ 2026-02-02 09:17:31,816 - INFO - STARTING TEST : test_svc_in_network_datapath 2026-02-02 09:17:32,078 - DEBUG - Nothing to compare xmpp stats {'10.0.0.19': {'10.20.0.254': '0'}} with 2026-02-02 09:17:32,078 - INFO - Initial checks done. Running the testcase now 2026-02-02 09:17:32,078 - INFO - 2026-02-02 09:17:32,660 - DEBUG - Response for create_network : {'network': {'id': '65230c8b-b9c0-4cee-b385-f4ba62827f51', 'name': 'ctest-mgmt_vn-54176284', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'project_id': '22ae1054eefe44a6b664f874550eebef', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-mgmt_vn-54176284'], 'port_security_enabled': True, 'description': ''}} 2026-02-02 09:17:32,901 - DEBUG - Response for create_subnet : {'subnet': {'id': '1ffc502e-ce3f-402a-a911-616083d4e5ab', 'name': '', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'network_id': '65230c8b-b9c0-4cee-b385-f4ba62827f51', 'ip_version': 4, 'cidr': '197.99.126.128/26', 'allocation_pools': [{'start': '197.99.126.130', 'end': '197.99.126.190'}], 'gateway_ip': '197.99.126.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '197.99.126.130', 'tags': [], 'project_id': '22ae1054eefe44a6b664f874550eebef'}} 2026-02-02 09:17:32,923 - INFO - Created VN ctest-mgmt_vn-54176284 2026-02-02 09:17:32,976 - DEBUG - VN ctest-mgmt_vn-54176284 UUID is 65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,086 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:33,378 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:33,411 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:33,423 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:33,493 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,504 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,512 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:17:33,519 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:17:33,526 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/ecc0495e-cbf1-4076-a5e3-0b87ef13d7eb 2026-02-02 09:17:33,533 - DEBUG - Route Targets: ['target:64512:8000004'] 2026-02-02 09:17:33,533 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,541 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:17:33,555 - INFO - Verified VN network id 11 for VN 65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,555 - INFO - Verifications in API Server for VN ctest-mgmt_vn-54176284 passed 2026-02-02 09:17:33,555 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,564 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:17:33,570 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:17:33,578 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/ecc0495e-cbf1-4076-a5e3-0b87ef13d7eb 2026-02-02 09:17:33,591 - DEBUG - Control-node 10.0.0.19 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-28608023', 'owner-access': '7', 'group': 'member', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7287682416271969518', 'uuid-lslong': '12936014586045431633'}, 'enable': 'true', 'created': '2026-02-02T09:17:32', 'last-modified': '2026-02-02T09:17:32', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.722643'} 2026-02-02 09:17:33,597 - DEBUG - Route Targets: ['target:64512:8000004'] 2026-02-02 09:17:33,597 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-54176284 passed 2026-02-02 09:17:33,598 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-54176284 in API_Server ====== 2026-02-02 09:17:33,598 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:33,604 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:33,615 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:33,689 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/65230c8b-b9c0-4cee-b385-f4ba62827f51 2026-02-02 09:17:33,700 - DEBUG - =>VN ctest-mgmt_vn-54176284 has no policy to be verified 2026-02-02 09:17:33,700 - DEBUG - Verifying the vn in opserver 2026-02-02 09:17:33,700 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 virtual network link through opserver 10.0.0.19 2026-02-02 09:17:33,700 - DEBUG - Requesting: http://10.0.0.19:8081/analytics/uves/virtual-networks 2026-02-02 09:17:33,993 - DEBUG - Requesting: http://10.0.0.19:8081/analytics/uves/virtual-networks 2026-02-02 09:17:34,053 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284', 'href': 'http://10.0.0.19:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284?flat'} 2026-02-02 09:17:34,053 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is found in opserver 2026-02-02 09:17:34,063 - DEBUG - Do not have enough data to verify VN in agent 2026-02-02 09:17:34,067 - DEBUG - VRF ids for VN ctest-mgmt_vn-54176284: {} 2026-02-02 09:17:34,264 - DEBUG - Response for create_network : {'network': {'id': '935f4873-476c-4649-98be-561b1fad48a1', 'name': 'ctest-left_vn-69176322', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'project_id': '22ae1054eefe44a6b664f874550eebef', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-left_vn-69176322'], 'port_security_enabled': True, 'description': ''}} 2026-02-02 09:17:34,438 - DEBUG - Response for create_subnet : {'subnet': {'id': 'aff0ece3-8575-4e73-8b7b-6c402c075cf8', 'name': '', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'network_id': '935f4873-476c-4649-98be-561b1fad48a1', 'ip_version': 4, 'cidr': '166.28.106.0/26', 'allocation_pools': [{'start': '166.28.106.2', 'end': '166.28.106.62'}], 'gateway_ip': '166.28.106.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '166.28.106.2', 'tags': [], 'project_id': '22ae1054eefe44a6b664f874550eebef'}} 2026-02-02 09:17:34,458 - INFO - Created VN ctest-left_vn-69176322 2026-02-02 09:17:34,508 - DEBUG - VN ctest-left_vn-69176322 UUID is 935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,622 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:34,630 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:34,642 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:34,718 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,729 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,738 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:17:34,745 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:17:34,752 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/d0a692db-4350-49f2-b69f-5e8559b530a8 2026-02-02 09:17:34,758 - DEBUG - Route Targets: ['target:64512:8000005'] 2026-02-02 09:17:34,758 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,766 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:17:34,781 - INFO - Verified VN network id 12 for VN 935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,782 - INFO - Verifications in API Server for VN ctest-left_vn-69176322 passed 2026-02-02 09:17:34,782 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,790 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:17:34,797 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:17:34,805 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/d0a692db-4350-49f2-b69f-5e8559b530a8 2026-02-02 09:17:34,817 - DEBUG - Control-node 10.0.0.19 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-28608023', 'owner-access': '7', 'group': 'member', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '10619286106319636041', 'uuid-lslong': '11006329213835626657'}, 'enable': 'true', 'created': '2026-02-02T09:17:34', 'last-modified': '2026-02-02T09:17:34', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.408706'} 2026-02-02 09:17:34,823 - DEBUG - Route Targets: ['target:64512:8000005'] 2026-02-02 09:17:34,823 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-left_vn-69176322 passed 2026-02-02 09:17:34,823 - DEBUG - ====Verifying policy data for ctest-left_vn-69176322 in API_Server ====== 2026-02-02 09:17:34,823 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:34,828 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:34,839 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:34,915 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/935f4873-476c-4649-98be-561b1fad48a1 2026-02-02 09:17:34,928 - DEBUG - =>VN ctest-left_vn-69176322 has no policy to be verified 2026-02-02 09:17:34,928 - DEBUG - Verifying the vn in opserver 2026-02-02 09:17:34,928 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 virtual network link through opserver 10.0.0.19 2026-02-02 09:17:34,928 - DEBUG - Requesting: http://10.0.0.19:8081/analytics/uves/virtual-networks 2026-02-02 09:17:34,939 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322', 'href': 'http://10.0.0.19:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322?flat'} 2026-02-02 09:17:34,939 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 is found in opserver 2026-02-02 09:17:34,949 - DEBUG - Do not have enough data to verify VN in agent 2026-02-02 09:17:34,954 - DEBUG - VRF ids for VN ctest-left_vn-69176322: {} 2026-02-02 09:17:35,137 - DEBUG - Response for create_network : {'network': {'id': 'f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5', 'name': 'ctest-right_vn-97982048', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'project_id': '22ae1054eefe44a6b664f874550eebef', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-right_vn-97982048'], 'port_security_enabled': True, 'description': ''}} 2026-02-02 09:17:35,295 - DEBUG - Response for create_subnet : {'subnet': {'id': 'aded0037-be7c-4614-aa4a-ba27b9207828', 'name': '', 'tenant_id': '22ae1054eefe44a6b664f874550eebef', 'network_id': 'f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5', 'ip_version': 4, 'cidr': '215.150.218.64/26', 'allocation_pools': [{'start': '215.150.218.66', 'end': '215.150.218.126'}], 'gateway_ip': '215.150.218.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '215.150.218.66', 'tags': [], 'project_id': '22ae1054eefe44a6b664f874550eebef'}} 2026-02-02 09:17:35,312 - INFO - Created VN ctest-right_vn-97982048 2026-02-02 09:17:35,364 - DEBUG - VN ctest-right_vn-97982048 UUID is f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,476 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:35,482 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:35,492 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:35,563 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,573 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,581 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:17:35,588 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:17:35,595 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/30c86a99-d789-47fb-afc0-a960a9baf6e8 2026-02-02 09:17:35,603 - DEBUG - Route Targets: ['target:64512:8000006'] 2026-02-02 09:17:35,603 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,613 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:17:35,630 - INFO - Verified VN network id 13 for VN f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,630 - INFO - Verifications in API Server for VN ctest-right_vn-97982048 passed 2026-02-02 09:17:35,630 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,639 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:17:35,647 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:17:35,654 - DEBUG - Requesting: http://10.0.0.19:8082/route-target/30c86a99-d789-47fb-afc0-a960a9baf6e8 2026-02-02 09:17:35,668 - DEBUG - Control-node 10.0.0.19 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-28608023', 'owner-access': '7', 'group': 'member', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17465852255925783281', 'uuid-lslong': '13571784169280165541'}, 'enable': 'true', 'created': '2026-02-02T09:17:35', 'last-modified': '2026-02-02T09:17:35', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.401722'} 2026-02-02 09:17:35,673 - DEBUG - Route Targets: ['target:64512:8000006'] 2026-02-02 09:17:35,673 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-right_vn-97982048 passed 2026-02-02 09:17:35,674 - DEBUG - ====Verifying policy data for ctest-right_vn-97982048 in API_Server ====== 2026-02-02 09:17:35,674 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:17:35,679 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:17:35,690 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:17:35,760 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-network/f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 2026-02-02 09:17:35,769 - DEBUG - =>VN ctest-right_vn-97982048 has no policy to be verified 2026-02-02 09:17:35,769 - DEBUG - Verifying the vn in opserver 2026-02-02 09:17:35,769 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 virtual network link through opserver 10.0.0.19 2026-02-02 09:17:35,769 - DEBUG - Requesting: http://10.0.0.19:8081/analytics/uves/virtual-networks 2026-02-02 09:17:35,779 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048', 'href': 'http://10.0.0.19:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048?flat'} 2026-02-02 09:17:35,779 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 is found in opserver 2026-02-02 09:17:35,788 - DEBUG - Do not have enough data to verify VN in agent 2026-02-02 09:17:35,793 - DEBUG - VRF ids for VN ctest-right_vn-97982048: {} 2026-02-02 09:17:35,854 - DEBUG - Services list from nova: [, , ] 2026-02-02 09:17:36,902 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5170-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5170-1) 2026-02-02 09:17:38,050 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5170-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5170-1) 2026-02-02 09:17:38,051 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-06783246'] 2026-02-02 09:17:38,412 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-06783246'] created succesfully 2026-02-02 09:17:38,769 - DEBUG - Image by name cirros_in_net not found 2026-02-02 09:17:38,769 - DEBUG - Installing image cirros_in_net 2026-02-02 09:17:38,770 - DEBUG - Image info {'name': 'cirros-in-net.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'cirros', 'password': 'gocubsgo', '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-02-02 09:17:38,770 - DEBUG - Image build path http://nexus.opensdn.io/repository///images/converts//cirros-in-net.vmdk.gz 2026-02-02 09:17:38,770 - DEBUG - Download image from web http://nexus.opensdn.io/repository///images/converts//cirros-in-net.vmdk.gz 2026-02-02 09:17:38,785 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: wget -nv http://nexus.opensdn.io/repository///images/converts//cirros-in-net.vmdk.gz -O /contrail-test/images/cirros-in-net.vmdk.gz 2026-02-02 09:17:38,967 - DEBUG - Image has been downloaded to /contrail-test/images/cirros-in-net.vmdk.gz 2026-02-02 09:17:38,967 - DEBUG - Unzip image 2026-02-02 09:17:38,967 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/cirros-in-net.vmdk.gz 2026-02-02 09:17:39,124 - DEBUG - Try to create image in user context 2026-02-02 09:17:39,357 - DEBUG - Image has been created in user context 2026-02-02 09:17:39,357 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: rm -f /contrail-test/images/cirros-in-net.vmdk 2026-02-02 09:17:39,374 - DEBUG - Downloaded image has been removed 2026-02-02 09:17:39,390 - DEBUG - Uploaded image status = active 2026-02-02 09:17:40,530 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5170-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5170-1) 2026-02-02 09:17:40,530 - INFO - Waiting for VM ctest-pt_svm0-31082579 to be up.. 2026-02-02 09:17:40,575 - DEBUG - VM is still in BUILD state, Expected: ACTIVE 2026-02-02 09:17:45,662 - DEBUG - VM is in ACTIVE state now 2026-02-02 09:17:45,662 - INFO - VM name : ctest-pt_svm0-31082579 2026-02-02 09:17:45,761 - DEBUG - VM ctest-pt_svm0-31082579 ID is 51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:17:45,781 - DEBUG - VM ctest-pt_svm0-31082579 launched on Node cn-jenkins-deploy-platform-ansible-os-5170-1 2026-02-02 09:17:46,062 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:17:46,072 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/242c5cf8-6c0f-44a9-9f63-e2bde92e4832 2026-02-02 09:17:46,081 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/59e13582-54c8-4498-bc04-24a254bec9e2 2026-02-02 09:17:46,090 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/9355fa55-e5bf-4a1a-b22a-7c1397d207d4 2026-02-02 09:17:49,380 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1006ms') 2026-02-02 09:17:49,380 - DEBUG - Ping to Metadata IP 169.254.0.5 of VM ctest-pt_svm0-31082579 failed! 2026-02-02 09:17:49,436 - DEBUG - Gateway for vn default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is 197.99.126.129 and allocation pool is NOT set 2026-02-02 09:17:53,507 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1011ms') 2026-02-02 09:17:53,507 - DEBUG - Ping to Metadata IP 169.254.0.5 of VM ctest-pt_svm0-31082579 failed! 2026-02-02 09:17:53,564 - DEBUG - Gateway for vn default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is 197.99.126.129 and allocation pool is NOT set 2026-02-02 09:17:57,638 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1011ms') 2026-02-02 09:17:57,639 - DEBUG - Ping to Metadata IP 169.254.0.5 of VM ctest-pt_svm0-31082579 failed! 2026-02-02 09:17:57,692 - DEBUG - Gateway for vn default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is 197.99.126.129 and allocation pool is NOT set 2026-02-02 09:18:01,764 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1010ms') 2026-02-02 09:18:01,765 - DEBUG - Ping to Metadata IP 169.254.0.5 of VM ctest-pt_svm0-31082579 failed! 2026-02-02 09:18:01,820 - DEBUG - Gateway for vn default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is 197.99.126.129 and allocation pool is NOT set 2026-02-02 09:18:03,883 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n64 bytes from 169.254.0.5: icmp_seq=1 ttl=63 time=3.94 ms\r\n64 bytes from 169.254.0.5: icmp_seq=2 ttl=63 time=0.924 ms\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.924/2.434/3.944/1.510 ms') 2026-02-02 09:18:03,884 - INFO - Ping to Metadata IP 169.254.0.5 of VM ctest-pt_svm0-31082579 passed 2026-02-02 09:18:04,036 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:04,036 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:04,103 - DEBUG - Error on ssh to cirros@169.254.0.5:22, result: /bin/bash: connect: Connection refused /bin/bash: line 1: /dev/tcp/169.254.0.5/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.5/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.5/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''} 2026-02-02 09:18:04,234 - DEBUG - VM ctest-pt_svm0-31082579 is NOT ready for SSH connections, VM status: ACTIVE 2026-02-02 09:18:09,236 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:09,236 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:09,295 - DEBUG - Error on ssh to cirros@169.254.0.5:22, result: /bin/bash: connect: Connection refused /bin/bash: line 1: /dev/tcp/169.254.0.5/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.5/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.5/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''} 2026-02-02 09:18:09,380 - DEBUG - VM ctest-pt_svm0-31082579 is NOT ready for SSH connections, VM status: ACTIVE 2026-02-02 09:18:14,380 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:14,380 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:14,458 - DEBUG - Error on ssh to cirros@169.254.0.5:22, result: /bin/bash: connect: Connection refused /bin/bash: line 1: /dev/tcp/169.254.0.5/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.5/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.5/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''} 2026-02-02 09:18:14,552 - DEBUG - VM ctest-pt_svm0-31082579 is NOT ready for SSH connections, VM status: ACTIVE 2026-02-02 09:18:19,553 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:19,553 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:19,722 - DEBUG - VM ctest-pt_svm0-31082579 is ready for SSH connections 2026-02-02 09:18:19,872 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:19,872 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:20,024 - DEBUG - VM ctest-pt_svm0-31082579 is ready for SSH connections 2026-02-02 09:18:20,176 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:20,176 - DEBUG - Waiting to SSH to VM ctest-pt_svm0-31082579, IP 197.99.126.131, Port 22 2026-02-02 09:18:20,342 - DEBUG - VM ctest-pt_svm0-31082579 is ready for SSH connections 2026-02-02 09:18:20,348 - DEBUG - Creating service instance: ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-si-43544759'] 2026-02-02 09:18:21,264 - INFO - Waiting for VM ctest-left_vm-97988312 to be up.. 2026-02-02 09:18:21,346 - DEBUG - VM is in ACTIVE state now 2026-02-02 09:18:21,346 - INFO - VM name : ctest-left_vm-97988312 2026-02-02 09:18:21,433 - DEBUG - VM ctest-left_vm-97988312 ID is 309f2062-ee9b-4822-be57-a0fb4d997cbb 2026-02-02 09:18:21,433 - DEBUG - VM ctest-left_vm-97988312 launched on Node cn-jenkins-deploy-platform-ansible-os-5170-1 2026-02-02 09:18:21,524 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/309f2062-ee9b-4822-be57-a0fb4d997cbb 2026-02-02 09:18:21,534 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/33a46d72-7b1a-4043-8046-95f5026f62b1 2026-02-02 09:18:22,777 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n64 bytes from 169.254.0.3: icmp_seq=1 ttl=63 time=4.74 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.522 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1002ms\r\nrtt min/avg/max/mdev = 0.522/2.629/4.736/2.107 ms') 2026-02-02 09:18:22,777 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-left_vm-97988312 passed 2026-02-02 09:18:22,932 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:22,932 - DEBUG - Waiting to SSH to VM ctest-left_vm-97988312, IP 166.28.106.3, Port 22 2026-02-02 09:18:23,088 - DEBUG - VM ctest-left_vm-97988312 is ready for SSH connections 2026-02-02 09:18:23,088 - INFO - Waiting for VM ctest-right_vm-68891954 to be up.. 2026-02-02 09:18:23,169 - DEBUG - VM is in ACTIVE state now 2026-02-02 09:18:23,169 - INFO - VM name : ctest-right_vm-68891954 2026-02-02 09:18:23,250 - DEBUG - VM ctest-right_vm-68891954 ID is 15341938-865d-4718-954a-70cf78af2224 2026-02-02 09:18:23,250 - DEBUG - VM ctest-right_vm-68891954 launched on Node cn-jenkins-deploy-platform-ansible-os-5170-1 2026-02-02 09:18:23,330 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/15341938-865d-4718-954a-70cf78af2224 2026-02-02 09:18:23,339 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/ba33a057-9cab-4f4a-b9a5-6d30fbee4394 2026-02-02 09:18:24,572 - DEBUG - (True, 'PING 169.254.0.4 (169.254.0.4) 56(84) bytes of data.\r\n64 bytes from 169.254.0.4: icmp_seq=1 ttl=63 time=3.08 ms\r\n64 bytes from 169.254.0.4: icmp_seq=2 ttl=63 time=0.419 ms\r\n\r\n--- 169.254.0.4 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.419/1.748/3.078/1.329 ms') 2026-02-02 09:18:24,572 - INFO - Ping to Metadata IP 169.254.0.4 of VM ctest-right_vm-68891954 passed 2026-02-02 09:18:24,728 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:24,728 - DEBUG - Waiting to SSH to VM ctest-right_vm-68891954, IP 215.150.218.67, Port 22 2026-02-02 09:18:24,888 - DEBUG - VM ctest-right_vm-68891954 is ready for SSH connections 2026-02-02 09:18:24,893 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = any, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = 0, end_port = 65535], application = [], dst_addresses = [subnet = None, virtual_network = default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048, security_group = None, network_policy = None, subnet_list = []], dst_ports = [start_port = 0, end_port = 65535], action_list = simple_action = pass, gateway_name = None, apply_service = ['default-domain:ctest-TestSvcRegr-28608023:ctest-si-43544759'], service_properties = None, mirror_to = None, assign_routing_instance = None, log = False, alert = False, qos_action = None, host_based_service = False, ethertype = None, created = None, last_modified = None, description = None] 2026-02-02 09:18:25,320 - INFO - Attaching policy ctest-policy-80655251 to vn ctest-left_vn-69176322 2026-02-02 09:18:25,852 - INFO - Attaching policy ctest-policy-80655251 to vn ctest-right_vn-97982048 2026-02-02 09:18:26,312 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-06783246'] created succesfully 2026-02-02 09:18:26,533 - DEBUG - Service instance: ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-si-43544759'] created succesfully 2026-02-02 09:18:26,533 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:26,539 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:26,551 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:26,625 - DEBUG - Requesting: http://10.0.0.19:8082/service-instance/285bf097-6919-4845-b7fd-63edb2cecb82 2026-02-02 09:18:26,634 - DEBUG - SI 'ctest-si-43544759' has service template ref to ctest-service_template_1-06783246 2026-02-02 09:18:26,634 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:26,640 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:26,651 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:26,722 - DEBUG - Requesting: http://10.0.0.19:8082/service-instance/285bf097-6919-4845-b7fd-63edb2cecb82 2026-02-02 09:18:26,732 - DEBUG - Requesting: http://10.0.0.19:8082/port-tuple/6f9884d3-2a5f-4aae-bb5e-b8e7b842ff89 2026-02-02 09:18:26,739 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/242c5cf8-6c0f-44a9-9f63-e2bde92e4832 2026-02-02 09:18:26,758 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/59e13582-54c8-4498-bc04-24a254bec9e2 2026-02-02 09:18:26,770 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/9355fa55-e5bf-4a1a-b22a-7c1397d207d4 2026-02-02 09:18:27,062 - DEBUG - VM is in ACTIVE state now 2026-02-02 09:18:27,536 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:18:27,544 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/242c5cf8-6c0f-44a9-9f63-e2bde92e4832 2026-02-02 09:18:27,558 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/59e13582-54c8-4498-bc04-24a254bec9e2 2026-02-02 09:18:27,568 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/9355fa55-e5bf-4a1a-b22a-7c1397d207d4 2026-02-02 09:18:27,579 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/0786979e-3267-400b-824a-97a6752ba953 2026-02-02 09:18:27,588 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/3f5f396e-4fc9-42d2-91e3-0cc8dc5b63c4 2026-02-02 09:18:27,595 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/af5afe39-fce7-41c6-91e6-66c349dfa9ec 2026-02-02 09:18:27,603 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/156cc208-a120-4c2e-85d1-790700568198 2026-02-02 09:18:27,611 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/84595d40-cfee-4904-adae-9d0d3c7d7356 2026-02-02 09:18:27,619 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/aa0cdd2a-dd16-4793-9cc0-e0422ee83661 2026-02-02 09:18:27,627 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/7cc5762d-5792-4f99-9b2c-7be5e8ab696c 2026-02-02 09:18:27,634 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/ba395704-901f-422a-989e-0dfbf2ebedba 2026-02-02 09:18:27,641 - DEBUG - Requesting: http://10.0.0.19:8082/instance-ip/fffd5d7b-85b6-4c4a-a683-3644e5f8ca69 2026-02-02 09:18:28,046 - DEBUG - VM is in ACTIVE state now 2026-02-02 09:18:28,046 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:18:28,053 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/242c5cf8-6c0f-44a9-9f63-e2bde92e4832 2026-02-02 09:18:28,063 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/59e13582-54c8-4498-bc04-24a254bec9e2 2026-02-02 09:18:28,072 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/9355fa55-e5bf-4a1a-b22a-7c1397d207d4 2026-02-02 09:18:29,314 - DEBUG - (True, 'PING 169.254.0.6 (169.254.0.6) 56(84) bytes of data.\r\n64 bytes from 169.254.0.6: icmp_seq=1 ttl=63 time=1.34 ms\r\n64 bytes from 169.254.0.6: icmp_seq=2 ttl=63 time=0.592 ms\r\n\r\n--- 169.254.0.6 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.592/0.965/1.338/0.373 ms') 2026-02-02 09:18:29,314 - INFO - Ping to Metadata IP 169.254.0.6 of VM ctest-pt_svm0-31082579 passed 2026-02-02 09:18:29,355 - DEBUG - VM ctest-pt_svm0-31082579 Tap interface: {'index': '6', 'name': 'tap9355fa55-e5', 'uuid': '9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322:ctest-left_vn-69176322', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '44', 'l2_label': '48', 'vxlan_id': '12', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '166.28.106.4', 'mac_addr': '02:93:55:fa:55:e5', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.6', 'service_vlan_list': None, 'os_ifindex': '41', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '42', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:29,355 - DEBUG - Agent 10.0.0.19 vrf name: default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322:ctest-left_vn-69176322 2026-02-02 09:18:29,361 - DEBUG - Agent VRF Object : {'vrf_list': [{'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322:ctest-left_vn-69176322', 'ucindex': '2', 'mcindex': '2', 'l2index': '2', 'source': 'Config; ', 'uc6index': '2', 'vn': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322', 'table_label': '-1', 'vxlan_id': '12', 'evpnindex': '2', 'brindex': '2', 'mplsindex': '0', 'RD': '10.20.0.254:2', 'mac_aging_time': '0', 'layer2_control_word': 'false', 'forwarding_vrf': None, 'hbf_rintf': '-1', 'hbf_lintf': '-1'}]} 2026-02-02 09:18:29,528 - DEBUG - VM ctest-pt_svm0-31082579 : Tap interface tap9355fa55-e5 is set to Active 2026-02-02 09:18:29,528 - DEBUG - Tap interface tap9355fa55-e5 detail : {'index': '6', 'name': 'tap9355fa55-e5', 'uuid': '9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322:ctest-left_vn-69176322', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '44', 'l2_label': '48', 'vxlan_id': '12', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '166.28.106.4', 'mac_addr': '02:93:55:fa:55:e5', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.6', 'service_vlan_list': None, 'os_ifindex': '41', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '42', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:29,728 - DEBUG - Starting Layer 2 verification in Agent 2026-02-02 09:18:29,740 - DEBUG - Layer 2 path is seen for VM MAC 02:93:55:fa:55:e5 in agent 10.0.0.19 2026-02-02 09:18:29,740 - DEBUG - Active layer 2 route in agent is present for VMI tap9355fa55-e5 2026-02-02 09:18:29,740 - DEBUG - L2 label(48) matches bw route table and interface table 2026-02-02 09:18:29,745 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 is found in Agent of node 10.0.0.19 2026-02-02 09:18:29,961 - DEBUG - VRF IDs of VN default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 is consistent in agent 10.0.0.19 2026-02-02 09:18:29,961 - DEBUG - Route for VM IP ['166.28.106.4'] is consistent in agent 10.0.0.19 2026-02-02 09:18:29,961 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 verification for VM ctest-pt_svm0-31082579 in Agent 10.0.0.19 passed 2026-02-02 09:18:30,156 - DEBUG - Starting all layer 2 verification in agent 10.0.0.19 2026-02-02 09:18:30,167 - DEBUG - Route for VM MAC 02:93:55:fa:55:e5 is consistent in agent 10.0.0.19 2026-02-02 09:18:30,187 - DEBUG - VM ctest-pt_svm0-31082579 Tap interface: {'index': '5', 'name': 'tap59e13582-54', 'uuid': '59e13582-54c8-4498-bc04-24a254bec9e2', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284:ctest-mgmt_vn-54176284', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '39', 'l2_label': '43', 'vxlan_id': '11', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '197.99.126.131', 'mac_addr': '02:59:e1:35:82:54', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.5', 'service_vlan_list': None, 'os_ifindex': '40', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:59e13582-54c8-4498-bc04-24a254bec9e2', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '43', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '00000000-0000-0000-0000-000000000000', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:30,187 - DEBUG - Agent 10.0.0.19 vrf name: default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284:ctest-mgmt_vn-54176284 2026-02-02 09:18:30,192 - DEBUG - Agent VRF Object : {'vrf_list': [{'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284:ctest-mgmt_vn-54176284', 'ucindex': '4', 'mcindex': '4', 'l2index': '4', 'source': 'Config; ', 'uc6index': '4', 'vn': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284', 'table_label': '-1', 'vxlan_id': '11', 'evpnindex': '4', 'brindex': '4', 'mplsindex': '0', 'RD': '10.20.0.254:4', 'mac_aging_time': '0', 'layer2_control_word': 'false', 'forwarding_vrf': None, 'hbf_rintf': '-1', 'hbf_lintf': '-1'}]} 2026-02-02 09:18:30,397 - DEBUG - VM ctest-pt_svm0-31082579 : Tap interface tap59e13582-54 is set to Active 2026-02-02 09:18:30,397 - DEBUG - Tap interface tap59e13582-54 detail : {'index': '5', 'name': 'tap59e13582-54', 'uuid': '59e13582-54c8-4498-bc04-24a254bec9e2', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284:ctest-mgmt_vn-54176284', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '39', 'l2_label': '43', 'vxlan_id': '11', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '197.99.126.131', 'mac_addr': '02:59:e1:35:82:54', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.5', 'service_vlan_list': None, 'os_ifindex': '40', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:59e13582-54c8-4498-bc04-24a254bec9e2', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '43', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '00000000-0000-0000-0000-000000000000', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:30,592 - DEBUG - Starting Layer 2 verification in Agent 2026-02-02 09:18:30,603 - DEBUG - Layer 2 path is seen for VM MAC 02:59:e1:35:82:54 in agent 10.0.0.19 2026-02-02 09:18:30,603 - DEBUG - Active layer 2 route in agent is present for VMI tap59e13582-54 2026-02-02 09:18:30,603 - DEBUG - L2 label(43) matches bw route table and interface table 2026-02-02 09:18:30,609 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is found in Agent of node 10.0.0.19 2026-02-02 09:18:30,817 - DEBUG - VRF IDs of VN default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 is consistent in agent 10.0.0.19 2026-02-02 09:18:30,818 - DEBUG - Route for VM IP ['197.99.126.131'] is consistent in agent 10.0.0.19 2026-02-02 09:18:30,818 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-mgmt_vn-54176284 verification for VM ctest-pt_svm0-31082579 in Agent 10.0.0.19 passed 2026-02-02 09:18:31,008 - DEBUG - Starting all layer 2 verification in agent 10.0.0.19 2026-02-02 09:18:31,020 - DEBUG - Route for VM MAC 02:59:e1:35:82:54 is consistent in agent 10.0.0.19 2026-02-02 09:18:31,044 - DEBUG - VM ctest-pt_svm0-31082579 Tap interface: {'index': '7', 'name': 'tap242c5cf8-6c', 'uuid': '242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048:ctest-right_vn-97982048', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '49', 'l2_label': '53', 'vxlan_id': '13', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '215.150.218.68', 'mac_addr': '02:24:2c:5c:f8:6c', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.7', 'service_vlan_list': None, 'os_ifindex': '42', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '26', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:31,044 - DEBUG - Agent 10.0.0.19 vrf name: default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048:ctest-right_vn-97982048 2026-02-02 09:18:31,050 - DEBUG - Agent VRF Object : {'vrf_list': [{'name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048:ctest-right_vn-97982048', 'ucindex': '3', 'mcindex': '3', 'l2index': '3', 'source': 'Config; ', 'uc6index': '3', 'vn': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048', 'table_label': '-1', 'vxlan_id': '13', 'evpnindex': '3', 'brindex': '3', 'mplsindex': '0', 'RD': '10.20.0.254:3', 'mac_aging_time': '0', 'layer2_control_word': 'false', 'forwarding_vrf': None, 'hbf_rintf': '-1', 'hbf_lintf': '-1'}]} 2026-02-02 09:18:31,216 - DEBUG - VM ctest-pt_svm0-31082579 : Tap interface tap242c5cf8-6c is set to Active 2026-02-02 09:18:31,216 - DEBUG - Tap interface tap242c5cf8-6c detail : {'index': '7', 'name': 'tap242c5cf8-6c', 'uuid': '242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'vrf_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048:ctest-right_vn-97982048', 'active': 'Active', 'ipv4_active': 'Active', 'l2_active': 'L2 Active', 'ip6_active': 'Ipv6 Inactive < no-ipv6-addr >', 'health_check_active': 'Active', 'dhcp_service': 'Enable', 'dhcp_service_v6': 'Disable', 'dns_service': 'Enable', 'type': 'vport', 'label': '49', 'l2_label': '53', 'vxlan_id': '13', 'vn_name': 'default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048', 'vm_uuid': '51fd7254-e23e-4e83-bc0a-e4b23d939f7b', 'vm_name': 'ctest-pt_svm0-31082579', 'ip_addr': '215.150.218.68', 'mac_addr': '02:24:2c:5c:f8:6c', 'policy': 'Enable', 'fip_list': [], 'mdata_ip_addr': '169.254.0.7', 'service_vlan_list': None, 'os_ifindex': '42', 'fabric_port': 'NotFabricPort', 'alloc_linklocal_ip': 'LL-Enable', 'analyzer_name': None, 'config_name': 'default-domain:ctest-TestSvcRegr-28608023:242c5cf8-6c0f-44a9-9f63-e2bde92e4832', 'sg_uuid_list': ['78d79885-eb1c-4ae9-bc19-3f428670e2b1'], 'static_route_list': None, 'vm_project_uuid': '22ae1054-eefe-44a6-b664-f874550eebef', 'admin_state': 'Enabled', 'flow_key_idx': '26', 'allowed_address_pair_list': None, 'ip6_addr': '::', 'local_preference': '0', 'tx_vlan_id': '-1', 'rx_vlan_id': '-1', 'parent_interface': None, 'subnet': '--NA--', 'sub_type': 'Tap', 'vrf_assign_acl_uuid': '--NA--', 'vmi_type': 'Virtual Machine', 'transport': 'Ethernet', 'logical_interface_uuid': '00000000-0000-0000-0000-000000000000', 'flood_unknown_unicast': 'false', 'physical_device': None, 'physical_interface': None, 'fixed_ip4_list': None, 'fixed_ip6_list': None, 'fat_flow_list': None, 'metadata_ip_active': 'Active', 'service_health_check_ip': '0.0.0.0', 'alias_ip_list': None, 'drop_new_flows': 'false', 'bridge_domain_list': [], 'vmi_tag_list': None, 'policy_set_acl_list': None, 'slo_list': None, 'vhostuser_mode': '0', 'si_other_end_vmi': '9355fa55-e5bf-4a1a-b22a-7c1397d207d4', 'cfg_igmp_enable': 'false', 'igmp_enabled': 'false', 'max_flows': '0', 'policy_set_fwaas_list': None, 'bond_interface_list': None, 'mac_ip_learning_enable': 'false', 'mac_ip_list': []} 2026-02-02 09:18:31,408 - DEBUG - Starting Layer 2 verification in Agent 2026-02-02 09:18:31,419 - DEBUG - Layer 2 path is seen for VM MAC 02:24:2c:5c:f8:6c in agent 10.0.0.19 2026-02-02 09:18:31,419 - DEBUG - Active layer 2 route in agent is present for VMI tap242c5cf8-6c 2026-02-02 09:18:31,419 - DEBUG - L2 label(53) matches bw route table and interface table 2026-02-02 09:18:31,425 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 is found in Agent of node 10.0.0.19 2026-02-02 09:18:31,636 - DEBUG - VRF IDs of VN default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 is consistent in agent 10.0.0.19 2026-02-02 09:18:31,636 - DEBUG - Route for VM IP ['215.150.218.68'] is consistent in agent 10.0.0.19 2026-02-02 09:18:31,636 - DEBUG - VN default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 verification for VM ctest-pt_svm0-31082579 in Agent 10.0.0.19 passed 2026-02-02 09:18:31,836 - DEBUG - Starting all layer 2 verification in agent 10.0.0.19 2026-02-02 09:18:31,847 - DEBUG - Route for VM MAC 02:24:2c:5c:f8:6c is consistent in agent 10.0.0.19 2026-02-02 09:18:31,848 - INFO - VM ctest-pt_svm0-31082579 verifications in Compute nodes passed 2026-02-02 09:18:31,848 - DEBUG - The SVMs in the SI are : [] 2026-02-02 09:18:31,848 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:18:31,856 - DEBUG - Service VM for SI 'ctest-si-43544759' is launched 2026-02-02 09:18:31,856 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:31,862 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:31,875 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:31,946 - DEBUG - Requesting: http://10.0.0.19:8082/service-instance/285bf097-6919-4845-b7fd-63edb2cecb82 2026-02-02 09:18:31,956 - DEBUG - SI ctest-si-43544759 has Port Tuple: ['ctest-port_tuple-47133336'] 2026-02-02 09:18:32,056 - INFO - VMI and/or RI refs are present for VN default-domain:ctest-TestSvcRegr-28608023:ctest-left_vn-69176322 2026-02-02 09:18:32,200 - INFO - VMI and/or RI refs are present for VN default-domain:ctest-TestSvcRegr-28608023:ctest-right_vn-97982048 2026-02-02 09:18:32,354 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,363 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,363 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,368 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,368 - INFO - Route to 215.150.218.67 seen in VRF:5 on cn-jenkins-deploy-platform-ansible-os-5170-1, and SI ctest-si-43544759 is seen as the NH 2026-02-02 09:18:32,522 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,529 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,530 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,535 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,535 - INFO - Route to 166.28.106.3 seen in VRF:6 on cn-jenkins-deploy-platform-ansible-os-5170-1, and SI ctest-si-43544759 is seen as the NH 2026-02-02 09:18:32,535 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,535 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-02 09:18:32,535 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 215.150.218.67, host_string: cirros@169.254.0.3, password: cubswin:)gateway: ubuntu@10.0.0.19, gateway password: c0ntrail123 2026-02-02 09:18:32,535 - DEBUG - ping -s 56 -c 3 -W 1 215.150.218.67 2026-02-02 09:18:36,604 - DEBUG - PING 215.150.218.67 (215.150.218.67): 56 data bytes 64 bytes from 215.150.218.67: seq=0 ttl=61 time=5.926 ms 64 bytes from 215.150.218.67: seq=1 ttl=61 time=1.781 ms 64 bytes from 215.150.218.67: seq=2 ttl=61 time=1.789 ms --- 215.150.218.67 ping statistics --- 3 packets transmitted, 3 packets received, 0% packet loss round-trip min/avg/max = 1.781/3.165/5.926 ms 2026-02-02 09:18:36,604 - INFO - Ping to IP 215.150.218.67 from VM ctest-left_vm-97988312 passed 2026-02-02 09:18:36,604 - INFO - Dettaching policy ctest-policy-80655251 from vn ctest-right_vn-97982048 2026-02-02 09:18:36,788 - INFO - Dettaching policy ctest-policy-80655251 from vn ctest-left_vn-69176322 2026-02-02 09:18:37,068 - INFO - Deleted policy ctest-policy-80655251 2026-02-02 09:18:37,069 - DEBUG - Deleting service instance: ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-si-43544759'] 2026-02-02 09:18:37,154 - INFO - Deleted SI ['default-domain', 'ctest-TestSvcRegr-28608023', 'ctest-si-43544759'] 2026-02-02 09:18:37,154 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:37,161 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:37,180 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:37,251 - DEBUG - Service instance ctest-si-43544759 removed from api server 2026-02-02 09:18:37,251 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/51fd7254-e23e-4e83-bc0a-e4b23d939f7b 2026-02-02 09:18:37,258 - DEBUG - All Service VMs unlinked from SI ctest-si-43544759 2026-02-02 09:18:37,263 - DEBUG - 0 svc intances found in all projects. They are [] 2026-02-02 09:18:37,263 - DEBUG - 0 svc intances found in current project. They are [] 2026-02-02 09:18:37,308 - DEBUG - 0 svc intances found in all projects. They are [] 2026-02-02 09:18:37,308 - DEBUG - 0 svc intances found in current project. They are [] 2026-02-02 09:18:37,308 - INFO - Deleting VM ctest-pt_svm0-31082579 2026-02-02 09:18:37,400 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-06783246'] 2026-02-02 09:18:37,496 - INFO - Service template: ['default-domain', 'ctest-service_template_1-06783246'] deleted successfully. 2026-02-02 09:18:37,496 - INFO - Deleting VM ctest-right_vm-68891954 2026-02-02 09:18:37,588 - INFO - Deleting VM ctest-left_vm-97988312 2026-02-02 09:18:37,687 - INFO - Deleting VN ctest-right_vn-97982048 2026-02-02 09:18:37,737 - DEBUG - VN f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5 still in use: Unable to complete operation on network f2632c16-b5e9-4af1-bc58-a9cbaa36d6a5. There are one or more ports still in use on the network. Neutron server returns request_ids: ['req-9ecad096-79e2-4546-991a-2d1bcfd90f66'] 2026-02-02 09:18:37,737 - WARNING - Deleting VN ctest-right_vn-97982048 failed..Will retry 2026-02-02 09:18:39,843 - DEBUG - Response for deleting network () 2026-02-02 09:18:39,843 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/8208e152-6502-4037-b23f-2126f0994f0f 2026-02-02 09:18:39,852 - DEBUG - Response Code: 404 2026-02-02 09:18:39,852 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:39,859 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:39,916 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:39,992 - INFO - Validated that VN ctest-right_vn-97982048 is not found in API Server 2026-02-02 09:18:40,006 - DEBUG - VN ctest-right_vn-97982048 is not present in Agent 10.0.0.19 2026-02-02 09:18:40,006 - INFO - Validated that VN ctest-right_vn-97982048 is not in any agent 2026-02-02 09:18:40,027 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-97982048 info 2026-02-02 09:18:40,027 - INFO - Deleting VN ctest-left_vn-69176322 2026-02-02 09:18:40,145 - DEBUG - Response for deleting network () 2026-02-02 09:18:40,145 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/269d38ec-8f91-4f57-bfe4-16cefffa1d84 2026-02-02 09:18:40,153 - DEBUG - Response Code: 404 2026-02-02 09:18:40,154 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:40,160 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:40,217 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:40,294 - INFO - Validated that VN ctest-left_vn-69176322 is not found in API Server 2026-02-02 09:18:40,304 - DEBUG - VN ctest-left_vn-69176322 is not present in Agent 10.0.0.19 2026-02-02 09:18:40,304 - INFO - Validated that VN ctest-left_vn-69176322 is not in any agent 2026-02-02 09:18:40,317 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-69176322 info 2026-02-02 09:18:40,318 - INFO - Deleting VN ctest-mgmt_vn-54176284 2026-02-02 09:18:40,429 - DEBUG - Response for deleting network () 2026-02-02 09:18:40,430 - DEBUG - Requesting: http://10.0.0.19:8082/routing-instance/0d533986-99ca-42f5-88d5-b9b749fe4d7e 2026-02-02 09:18:40,438 - DEBUG - Response Code: 404 2026-02-02 09:18:40,438 - DEBUG - Requesting: http://10.0.0.19:8082/domains 2026-02-02 09:18:40,444 - DEBUG - Requesting: http://10.0.0.19:8082/domain/e95fce11-2ae1-425a-b2ce-6e2e6df5975a 2026-02-02 09:18:40,497 - DEBUG - Requesting: http://10.0.0.19:8082/project/22ae1054-eefe-44a6-b664-f874550eebef 2026-02-02 09:18:40,567 - INFO - Validated that VN ctest-mgmt_vn-54176284 is not found in API Server 2026-02-02 09:18:40,576 - DEBUG - VN ctest-mgmt_vn-54176284 is not present in Agent 10.0.0.19 2026-02-02 09:18:40,576 - INFO - Validated that VN ctest-mgmt_vn-54176284 is not in any agent 2026-02-02 09:18:40,590 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-54176284 info 2026-02-02 09:18:40,857 - DEBUG - No XMPP flaps were noticed during the test 2026-02-02 09:18:40,857 - INFO -
2026-02-02 09:18:40,857 - INFO - END TEST : test_svc_in_network_datapath : PASSED[0:01:09]
2026-02-02 09:18:40,857 - INFO - -------------------------------------------------------------------------------- 2026-02-02 09:18:41,581 - INFO - Deleted project: ctest-TestSvcRegr-28608023, ID : 22ae1054-eefe-44a6-b664-f874550eebef