2025-08-11 16:50:07,917 - INFO - Domain Default found not creating 2025-08-11 16:50:08,054 - INFO - Project ctest-TestRP-61808228 not found, creating it 2025-08-11 16:50:08,592 - INFO - Created Project:ctest-TestRP-61808228, ID : b30a220d-9557-4240-bc42-ae6814e5535b 2025-08-11 16:50:10,019 - DEBUG - Services list from nova: [, , , ] 2025-08-11 16:50:10,020 - DEBUG - Hosts: {'nova': ['an-jenkins-deploy-platform-ansible-os-3816-2', 'an-jenkins-deploy-platform-ansible-os-3816-1']} 2025-08-11 16:50:10,022 - INFO - ================================================================================ 2025-08-11 16:50:10,022 - INFO - STARTING TEST : test_rp_interface 2025-08-11 16:50:10,022 - INFO - TEST DESCRIPTION : 1. Create a routing policy with interface match. 2. Launch VMs. 3. Attach policy to VN and confirm if policy takes hold. 2025-08-11 16:50:11,270 - DEBUG - Nothing to compare xmpp stats {'10.0.0.141': {'10.20.0.192': '0', '10.20.0.193': '0'}, '10.0.0.249': {'10.20.0.193': '0', '10.20.0.192': '0'}} with 2025-08-11 16:50:11,271 - INFO - Initial checks done. Running the testcase now 2025-08-11 16:50:11,271 - INFO - 2025-08-11 16:50:11,898 - DEBUG - Response for create_network : {'network': {'id': '9c3b3391-a2cd-4179-8957-668897c8c5a6', 'name': 'ctest-bgpaas_vn-35700646', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-35700646'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:50:12,193 - DEBUG - Response for create_subnet : {'subnet': {'id': '4dadc7ef-4205-4d75-aef5-28b48ec6f396', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': '9c3b3391-a2cd-4179-8957-668897c8c5a6', 'ip_version': 4, 'cidr': '116.167.241.0/26', 'allocation_pools': [{'start': '116.167.241.2', 'end': '116.167.241.62'}], 'gateway_ip': '116.167.241.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '116.167.241.2', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:50:12,216 - INFO - Created VN ctest-bgpaas_vn-35700646 2025-08-11 16:50:12,230 - DEBUG - VN ctest-bgpaas_vn-35700646 UUID is 9c3b3391-a2cd-4179-8957-668897c8c5a6 2025-08-11 16:50:12,767 - DEBUG - Response for create_network : {'network': {'id': '90834a13-10e6-4590-8aac-7fa6d336062c', 'name': 'ctest-bgpaas_vn-73653896', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-73653896'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:50:13,035 - DEBUG - Response for create_subnet : {'subnet': {'id': 'fe8086d1-9790-4143-af20-0ac8e14d17d6', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': '90834a13-10e6-4590-8aac-7fa6d336062c', 'ip_version': 4, 'cidr': '52.7.25.0/26', 'allocation_pools': [{'start': '52.7.25.2', 'end': '52.7.25.62'}], 'gateway_ip': '52.7.25.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '52.7.25.2', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:50:13,055 - INFO - Created VN ctest-bgpaas_vn-73653896 2025-08-11 16:50:13,072 - DEBUG - VN ctest-bgpaas_vn-73653896 UUID is 90834a13-10e6-4590-8aac-7fa6d336062c 2025-08-11 16:50:14,421 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-2) 2025-08-11 16:50:15,665 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-1) 2025-08-11 16:50:15,665 - INFO - Waiting for VM test_vm to be up.. 2025-08-11 16:50:15,748 - DEBUG - VM is still in BUILD state, Expected: ACTIVE 2025-08-11 16:50:20,823 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:50:20,823 - INFO - VM name : test_vm 2025-08-11 16:50:20,896 - DEBUG - VM test_vm ID is 89b2b9e8-5fdf-41d2-a57f-73316ba607ce 2025-08-11 16:50:20,919 - DEBUG - VM test_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-2 2025-08-11 16:50:20,987 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/89b2b9e8-5fdf-41d2-a57f-73316ba607ce 2025-08-11 16:50:21,275 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/89b2b9e8-5fdf-41d2-a57f-73316ba607ce 2025-08-11 16:50:21,307 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/aa463901-660e-4275-9cf7-481bcbf9291f 2025-08-11 16:50:24,528 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1023ms') 2025-08-11 16:50:24,528 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM test_vm failed! 2025-08-11 16:50:24,543 - DEBUG - Gateway for vn default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-35700646 is 116.167.241.1 and allocation pool is NOT set 2025-08-11 16:50:26,607 - 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=5.45 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=1.83 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 1.825/3.635/5.446/1.810 ms') 2025-08-11 16:50:26,607 - INFO - Ping to Metadata IP 169.254.0.3 of VM test_vm passed 2025-08-11 16:50:26,723 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:26,723 - DEBUG - Waiting to SSH to VM test_vm, IP 116.167.241.3, Port 22 2025-08-11 16:50:26,882 - DEBUG - VM test_vm is ready for SSH connections 2025-08-11 16:50:26,882 - INFO - Waiting for VM test2_vm to be up.. 2025-08-11 16:50:26,951 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:50:26,951 - INFO - VM name : test2_vm 2025-08-11 16:50:27,018 - DEBUG - VM test2_vm ID is 56f5fb09-daed-405f-b573-db47a80553ad 2025-08-11 16:50:27,019 - DEBUG - VM test2_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-1 2025-08-11 16:50:27,112 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/56f5fb09-daed-405f-b573-db47a80553ad 2025-08-11 16:50:27,139 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/b8e67df9-51cd-45cb-b075-c400701766cc 2025-08-11 16:50:28,369 - 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=2.67 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.371 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.371/1.518/2.665/1.147 ms') 2025-08-11 16:50:28,369 - INFO - Ping to Metadata IP 169.254.0.3 of VM test2_vm passed 2025-08-11 16:50:28,481 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:28,481 - DEBUG - Waiting to SSH to VM test2_vm, IP 52.7.25.3, Port 22 2025-08-11 16:50:28,634 - DEBUG - VM test2_vm is ready for SSH connections 2025-08-11 16:50:28,814 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:28,826 - DEBUG - Requesting: http://10.20.0.193:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-35700646:ctest-bgpaas_vn-35700646.inet.0 2025-08-11 16:50:28,839 - DEBUG - Requesting: http://10.20.0.192:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-35700646:ctest-bgpaas_vn-35700646.inet.0 2025-08-11 16:50:28,853 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:28,853 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 52.7.25.3, host_string: cirros@169.254.0.3, password: cubswin:)gateway: ubuntu@10.0.0.249, gateway password: c0ntrail123 2025-08-11 16:50:28,853 - DEBUG - ping -s 56 -c 3 -W 1 52.7.25.3 2025-08-11 16:50:32,716 - DEBUG - PING 52.7.25.3 (52.7.25.3): 56 data bytes 64 bytes from 52.7.25.3: seq=0 ttl=63 time=5.554 ms 64 bytes from 52.7.25.3: seq=1 ttl=63 time=1.215 ms 64 bytes from 52.7.25.3: seq=2 ttl=63 time=1.171 ms --- 52.7.25.3 ping statistics --- 3 packets transmitted, 3 packets received, 0% packet loss round-trip min/avg/max = 1.171/2.646/5.554 ms 2025-08-11 16:50:32,716 - INFO - Ping to IP 52.7.25.3 from VM test_vm passed 2025-08-11 16:50:32,808 - INFO - Deleting VM test2_vm 2025-08-11 16:50:32,870 - INFO - Deleting VM test_vm 2025-08-11 16:50:32,928 - INFO - Deleting VN ctest-bgpaas_vn-73653896 2025-08-11 16:50:32,965 - DEBUG - VN 90834a13-10e6-4590-8aac-7fa6d336062c still in use: Unable to complete operation on network 90834a13-10e6-4590-8aac-7fa6d336062c. There are one or more ports still in use on the network. Neutron server returns request_ids: ['req-0ca34a15-c06c-4ddd-91a4-046744a3513a'] 2025-08-11 16:50:32,965 - WARNING - Deleting VN ctest-bgpaas_vn-73653896 failed..Will retry 2025-08-11 16:50:35,094 - DEBUG - Response for deleting network () 2025-08-11 16:50:35,094 - INFO - Deleting VN ctest-bgpaas_vn-35700646 2025-08-11 16:50:35,282 - DEBUG - Response for deleting network () 2025-08-11 16:50:36,537 - DEBUG - No XMPP flaps were noticed during the test
2025-08-11 16:50:36,537 - INFO - END TEST : test_rp_interface : PASSED[0:00:26]
2025-08-11 16:50:36,537 - INFO - -------------------------------------------------------------------------------- 2025-08-11 16:50:36,541 - INFO - ================================================================================ 2025-08-11 16:50:36,541 - INFO - STARTING TEST : test_rp_interface_ext_community 2025-08-11 16:50:36,541 - INFO - TEST DESCRIPTION : 1. Create a routing policy with interface match. 2. Launch VMs. 3. Attach policy to VN and confirm if policy takes hold. 2025-08-11 16:50:37,809 - DEBUG - Nothing to compare xmpp stats {'10.0.0.141': {'10.20.0.192': '0', '10.20.0.193': '0'}, '10.0.0.249': {'10.20.0.193': '0', '10.20.0.192': '0'}} with 2025-08-11 16:50:37,809 - INFO - Initial checks done. Running the testcase now 2025-08-11 16:50:37,809 - INFO - 2025-08-11 16:50:38,071 - DEBUG - Response for create_network : {'network': {'id': 'bcfa0674-81dc-4c12-8d42-589f7758cf59', 'name': 'ctest-bgpaas_vn-97677375', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-97677375'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:50:38,262 - DEBUG - Response for create_subnet : {'subnet': {'id': '0a758ba6-71ba-4f53-9ad0-ced4252a6b8d', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': 'bcfa0674-81dc-4c12-8d42-589f7758cf59', 'ip_version': 4, 'cidr': '124.137.158.192/26', 'allocation_pools': [{'start': '124.137.158.194', 'end': '124.137.158.254'}], 'gateway_ip': '124.137.158.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '124.137.158.194', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:50:38,281 - INFO - Created VN ctest-bgpaas_vn-97677375 2025-08-11 16:50:38,292 - DEBUG - VN ctest-bgpaas_vn-97677375 UUID is bcfa0674-81dc-4c12-8d42-589f7758cf59 2025-08-11 16:50:38,797 - DEBUG - Response for create_network : {'network': {'id': '0fc2aaa7-71f5-4d75-88e3-28e7007ebc0e', 'name': 'ctest-bgpaas_vn-25713687', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-25713687'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:50:38,996 - DEBUG - Response for create_subnet : {'subnet': {'id': '75f1b0dc-2303-4b27-94b4-428005a22565', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': '0fc2aaa7-71f5-4d75-88e3-28e7007ebc0e', 'ip_version': 4, 'cidr': '33.187.190.64/26', 'allocation_pools': [{'start': '33.187.190.66', 'end': '33.187.190.126'}], 'gateway_ip': '33.187.190.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '33.187.190.66', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:50:39,015 - INFO - Created VN ctest-bgpaas_vn-25713687 2025-08-11 16:50:39,027 - DEBUG - VN ctest-bgpaas_vn-25713687 UUID is 0fc2aaa7-71f5-4d75-88e3-28e7007ebc0e 2025-08-11 16:50:40,379 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-2) 2025-08-11 16:50:41,806 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-1) 2025-08-11 16:50:41,806 - INFO - Waiting for VM test_vm to be up.. 2025-08-11 16:50:41,915 - DEBUG - VM is still in BUILD state, Expected: ACTIVE 2025-08-11 16:50:46,988 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:50:46,988 - INFO - VM name : test_vm 2025-08-11 16:50:47,056 - DEBUG - VM test_vm ID is 5d3d6d78-75ae-42ca-8873-ac64b9ec1359 2025-08-11 16:50:47,056 - DEBUG - VM test_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-2 2025-08-11 16:50:47,128 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/5d3d6d78-75ae-42ca-8873-ac64b9ec1359 2025-08-11 16:50:47,139 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/fe28c893-eb6d-49aa-88c7-563a2692dbed 2025-08-11 16:50:50,360 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1016ms') 2025-08-11 16:50:50,360 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM test_vm failed! 2025-08-11 16:50:50,377 - DEBUG - Gateway for vn default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-97677375 is 124.137.158.193 and allocation pool is NOT set 2025-08-11 16:50:52,436 - 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=2.71 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.329 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.329/1.517/2.706/1.188 ms') 2025-08-11 16:50:52,436 - INFO - Ping to Metadata IP 169.254.0.3 of VM test_vm passed 2025-08-11 16:50:52,550 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:52,550 - DEBUG - Waiting to SSH to VM test_vm, IP 124.137.158.195, Port 22 2025-08-11 16:50:52,702 - DEBUG - VM test_vm is ready for SSH connections 2025-08-11 16:50:52,702 - INFO - Waiting for VM test2_vm to be up.. 2025-08-11 16:50:52,782 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:50:52,782 - INFO - VM name : test2_vm 2025-08-11 16:50:52,859 - DEBUG - VM test2_vm ID is c1ac6201-51fd-4801-8d0e-03927521ce42 2025-08-11 16:50:52,859 - DEBUG - VM test2_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-1 2025-08-11 16:50:52,943 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/c1ac6201-51fd-4801-8d0e-03927521ce42 2025-08-11 16:50:52,953 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/ca663124-a20f-4ee7-ab24-65a3bda1df13 2025-08-11 16:50:54,163 - 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=2.71 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.368 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.368/1.539/2.710/1.171 ms') 2025-08-11 16:50:54,163 - INFO - Ping to Metadata IP 169.254.0.3 of VM test2_vm passed 2025-08-11 16:50:54,275 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:54,275 - DEBUG - Waiting to SSH to VM test2_vm, IP 33.187.190.67, Port 22 2025-08-11 16:50:54,430 - DEBUG - VM test2_vm is ready for SSH connections 2025-08-11 16:50:54,574 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:54,587 - DEBUG - Requesting: http://10.20.0.193:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-97677375:ctest-bgpaas_vn-97677375.inet.0 2025-08-11 16:50:54,599 - DEBUG - Requesting: http://10.20.0.192:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-97677375:ctest-bgpaas_vn-97677375.inet.0 2025-08-11 16:50:54,614 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:54,614 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 33.187.190.67, host_string: cirros@169.254.0.3, password: cubswin:)gateway: ubuntu@10.0.0.249, gateway password: c0ntrail123 2025-08-11 16:50:54,614 - DEBUG - ping -s 56 -c 3 -W 1 33.187.190.67 2025-08-11 16:50:58,252 - DEBUG - PING 33.187.190.67 (33.187.190.67): 56 data bytes 64 bytes from 33.187.190.67: seq=0 ttl=63 time=5.422 ms 64 bytes from 33.187.190.67: seq=1 ttl=63 time=1.107 ms 64 bytes from 33.187.190.67: seq=2 ttl=63 time=1.163 ms --- 33.187.190.67 ping statistics --- 3 packets transmitted, 3 packets received, 0% packet loss round-trip min/avg/max = 1.107/2.564/5.422 ms 2025-08-11 16:50:58,252 - INFO - Ping to IP 33.187.190.67 from VM test_vm passed 2025-08-11 16:50:58,394 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:50:58,409 - DEBUG - Requesting: http://10.20.0.193:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-97677375:ctest-bgpaas_vn-97677375.inet.0 2025-08-11 16:50:58,421 - DEBUG - Requesting: http://10.20.0.192:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-97677375:ctest-bgpaas_vn-97677375.inet.0 2025-08-11 16:50:58,688 - INFO - Deleting VM test2_vm 2025-08-11 16:50:58,748 - INFO - Deleting VM test_vm 2025-08-11 16:50:58,811 - INFO - Deleting VN ctest-bgpaas_vn-25713687 2025-08-11 16:50:58,852 - DEBUG - VN 0fc2aaa7-71f5-4d75-88e3-28e7007ebc0e still in use: Unable to complete operation on network 0fc2aaa7-71f5-4d75-88e3-28e7007ebc0e. There are one or more ports still in use on the network. Neutron server returns request_ids: ['req-96375074-a794-4e9a-b6d4-6d0a636a55ad'] 2025-08-11 16:50:58,852 - WARNING - Deleting VN ctest-bgpaas_vn-25713687 failed..Will retry 2025-08-11 16:51:00,979 - DEBUG - Response for deleting network () 2025-08-11 16:51:00,979 - INFO - Deleting VN ctest-bgpaas_vn-97677375 2025-08-11 16:51:01,147 - DEBUG - Response for deleting network () 2025-08-11 16:51:02,403 - DEBUG - No XMPP flaps were noticed during the test
2025-08-11 16:51:02,403 - INFO - END TEST : test_rp_interface_ext_community : PASSED[0:00:26]
2025-08-11 16:51:02,403 - INFO - -------------------------------------------------------------------------------- 2025-08-11 16:51:02,405 - INFO - ================================================================================ 2025-08-11 16:51:02,406 - INFO - STARTING TEST : test_rp_interface_static 2025-08-11 16:51:02,406 - INFO - TEST DESCRIPTION : 1. Create a routing policy with interface-static match. 2. Launch VMs. 3. Attach policy to VN and confirm if policy takes hold. 2025-08-11 16:51:03,662 - DEBUG - Nothing to compare xmpp stats {'10.0.0.141': {'10.20.0.192': '0', '10.20.0.193': '0'}, '10.0.0.249': {'10.20.0.193': '0', '10.20.0.192': '0'}} with 2025-08-11 16:51:03,662 - INFO - Initial checks done. Running the testcase now 2025-08-11 16:51:03,662 - INFO - 2025-08-11 16:51:03,884 - DEBUG - Response for create_network : {'network': {'id': 'be784811-6d09-4789-b5e2-57b20389f3e0', 'name': 'ctest-bgpaas_vn-42800145', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-42800145'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:51:04,117 - DEBUG - Response for create_subnet : {'subnet': {'id': '77c130ba-90d8-4381-9c85-a24204fae872', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': 'be784811-6d09-4789-b5e2-57b20389f3e0', 'ip_version': 4, 'cidr': '120.210.119.192/26', 'allocation_pools': [{'start': '120.210.119.194', 'end': '120.210.119.254'}], 'gateway_ip': '120.210.119.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '120.210.119.194', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:51:04,138 - INFO - Created VN ctest-bgpaas_vn-42800145 2025-08-11 16:51:04,150 - DEBUG - VN ctest-bgpaas_vn-42800145 UUID is be784811-6d09-4789-b5e2-57b20389f3e0 2025-08-11 16:51:04,658 - DEBUG - Response for create_network : {'network': {'id': '78b8be8f-25fd-4f9f-8c7e-886f0ea750f0', 'name': 'ctest-bgpaas_vn-73067860', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'project_id': 'b30a220d95574240bc42ae6814e5535b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestRP-61808228', 'ctest-bgpaas_vn-73067860'], 'port_security_enabled': True, 'description': ''}} 2025-08-11 16:51:04,867 - DEBUG - Response for create_subnet : {'subnet': {'id': 'a4c8f301-635b-484d-9d94-6ada8197422e', 'name': '', 'tenant_id': 'b30a220d95574240bc42ae6814e5535b', 'network_id': '78b8be8f-25fd-4f9f-8c7e-886f0ea750f0', 'ip_version': 4, 'cidr': '189.246.132.64/26', 'allocation_pools': [{'start': '189.246.132.66', 'end': '189.246.132.126'}], 'gateway_ip': '189.246.132.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '189.246.132.66', 'tags': [], 'project_id': 'b30a220d95574240bc42ae6814e5535b'}} 2025-08-11 16:51:04,888 - INFO - Created VN ctest-bgpaas_vn-73067860 2025-08-11 16:51:04,899 - DEBUG - VN ctest-bgpaas_vn-73067860 UUID is 78b8be8f-25fd-4f9f-8c7e-886f0ea750f0 2025-08-11 16:51:06,100 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-2) 2025-08-11 16:51:07,266 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3816-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3816-1) 2025-08-11 16:51:07,267 - INFO - Waiting for VM test_vm to be up.. 2025-08-11 16:51:07,345 - DEBUG - VM is still in BUILD state, Expected: ACTIVE 2025-08-11 16:51:12,412 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:51:12,412 - INFO - VM name : test_vm 2025-08-11 16:51:12,476 - DEBUG - VM test_vm ID is f67aa935-d25a-466d-b61a-537bfaa7b1a4 2025-08-11 16:51:12,477 - DEBUG - VM test_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-2 2025-08-11 16:51:12,540 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/f67aa935-d25a-466d-b61a-537bfaa7b1a4 2025-08-11 16:51:12,550 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/10cf9c98-5850-4ad3-b5de-e45925e5e016 2025-08-11 16:51:15,767 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1016ms') 2025-08-11 16:51:15,767 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM test_vm failed! 2025-08-11 16:51:15,782 - DEBUG - Gateway for vn default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-42800145 is 120.210.119.193 and allocation pool is NOT set 2025-08-11 16:51:17,847 - 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=2.98 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.379 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.379/1.680/2.981/1.301 ms') 2025-08-11 16:51:17,847 - INFO - Ping to Metadata IP 169.254.0.3 of VM test_vm passed 2025-08-11 16:51:17,963 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:51:17,963 - DEBUG - Waiting to SSH to VM test_vm, IP 120.210.119.195, Port 22 2025-08-11 16:51:18,114 - DEBUG - VM test_vm is ready for SSH connections 2025-08-11 16:51:18,114 - INFO - Waiting for VM test2_vm to be up.. 2025-08-11 16:51:18,240 - DEBUG - VM is in ACTIVE state now 2025-08-11 16:51:18,240 - INFO - VM name : test2_vm 2025-08-11 16:51:18,347 - DEBUG - VM test2_vm ID is 9ddb64ce-265f-4bd0-a2d6-9b35f1db614b 2025-08-11 16:51:18,347 - DEBUG - VM test2_vm launched on Node an-jenkins-deploy-platform-ansible-os-3816-1 2025-08-11 16:51:18,426 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine/9ddb64ce-265f-4bd0-a2d6-9b35f1db614b 2025-08-11 16:51:18,438 - DEBUG - Requesting: http://10.0.0.19:8082/virtual-machine-interface/8651f193-9b57-484a-bf5c-3c6746b56939 2025-08-11 16:51:19,658 - 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=1.79 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.317 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.317/1.053/1.789/0.736 ms') 2025-08-11 16:51:19,658 - INFO - Ping to Metadata IP 169.254.0.3 of VM test2_vm passed 2025-08-11 16:51:19,767 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:51:19,767 - DEBUG - Waiting to SSH to VM test2_vm, IP 189.246.132.67, Port 22 2025-08-11 16:51:19,922 - DEBUG - VM test2_vm is ready for SSH connections 2025-08-11 16:51:20,011 - INFO - Created InterfaceRouteTable ['default-domain', 'ctest-TestRP-61808228', 'ctest-int_table_right-41024305'](UUID 4d6a24b7-3f02-4ce5-a92a-c84cad9c7f3e), prefixes : ['176.43.114.192/26'] 2025-08-11 16:51:20,078 - INFO - Added intf route table 4d6a24b7-3f02-4ce5-a92a-c84cad9c7f3e to port 10cf9c98-5850-4ad3-b5de-e45925e5e016 2025-08-11 16:51:20,274 - DEBUG - Requesting: http://10.20.0.193:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-42800145:ctest-bgpaas_vn-42800145.inet.0 2025-08-11 16:51:20,289 - DEBUG - Requesting: http://10.20.0.192:8083/Snh_ShowRouteReq?x=default-domain:ctest-TestRP-61808228:ctest-bgpaas_vn-42800145:ctest-bgpaas_vn-42800145.inet.0 2025-08-11 16:51:20,305 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2025-08-11 16:51:20,306 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 189.246.132.67, host_string: cirros@169.254.0.3, password: cubswin:)gateway: ubuntu@10.0.0.249, gateway password: c0ntrail123 2025-08-11 16:51:20,306 - DEBUG - ping -s 56 -c 3 -W 1 189.246.132.67 2025-08-11 16:51:23,994 - DEBUG - PING 189.246.132.67 (189.246.132.67): 56 data bytes 64 bytes from 189.246.132.67: seq=0 ttl=63 time=5.039 ms 64 bytes from 189.246.132.67: seq=1 ttl=63 time=1.090 ms 64 bytes from 189.246.132.67: seq=2 ttl=63 time=1.063 ms --- 189.246.132.67 ping statistics --- 3 packets transmitted, 3 packets received, 0% packet loss round-trip min/avg/max = 1.063/2.397/5.039 ms 2025-08-11 16:51:23,994 - INFO - Ping to IP 189.246.132.67 from VM test_vm passed 2025-08-11 16:51:24,088 - INFO - Deleting VM test2_vm 2025-08-11 16:51:24,161 - INFO - Deleting VM test_vm 2025-08-11 16:51:24,221 - INFO - Deleting VN ctest-bgpaas_vn-73067860 2025-08-11 16:51:24,255 - DEBUG - VN 78b8be8f-25fd-4f9f-8c7e-886f0ea750f0 still in use: Unable to complete operation on network 78b8be8f-25fd-4f9f-8c7e-886f0ea750f0. There are one or more ports still in use on the network. Neutron server returns request_ids: ['req-189b3966-039f-429e-889d-5fa58398219f'] 2025-08-11 16:51:24,255 - WARNING - Deleting VN ctest-bgpaas_vn-73067860 failed..Will retry 2025-08-11 16:51:26,394 - DEBUG - Response for deleting network () 2025-08-11 16:51:26,395 - INFO - Deleting VN ctest-bgpaas_vn-42800145 2025-08-11 16:51:26,543 - DEBUG - Response for deleting network () 2025-08-11 16:51:27,809 - DEBUG - No XMPP flaps were noticed during the test
2025-08-11 16:51:27,809 - INFO - END TEST : test_rp_interface_static : PASSED[0:00:25]
2025-08-11 16:51:27,810 - INFO - -------------------------------------------------------------------------------- 2025-08-11 16:51:28,510 - INFO - Deleted project: ctest-TestRP-61808228, ID : b30a220d-9557-4240-bc42-ae6814e5535b