2025-07-23 16:24:48,709 - INFO - Domain Default found not creating
2025-07-23 16:24:48,858 - INFO - Project ctest-TestStaticRouteTables-02371742 not found, creating it
2025-07-23 16:24:49,385 - INFO - Created Project:ctest-TestStaticRouteTables-02371742, ID : 5628bfbf-c006-466f-91a9-13dc8e249356
2025-07-23 16:24:50,844 - INFO - ================================================================================
2025-07-23 16:24:50,844 - INFO - STARTING TEST : test_interface_static_table
2025-07-23 16:24:50,844 - INFO - TEST DESCRIPTION :
Description: Validate interface static table
Test steps:
1. Creating vm's - vm1 and vm2 and middle vm in networks vn1 and vn2.
2. Creating interface static table betn left and right vm
3. Apply static table to the middle ports.
4. Checking for ping and tcp traffic between vm1 and vm2.
Pass criteria: Ping between the VMs should be successful and route should be in the agent
2025-07-23 16:24:52,174 - DEBUG - Nothing to compare xmpp stats {'10.0.0.50': {'10.20.0.254': '0', '10.20.0.17': '0'}, '10.0.0.130': {'10.20.0.17': '0', '10.20.0.254': '0'}} with
2025-07-23 16:24:52,174 - INFO - Initial checks done. Running the testcase now
2025-07-23 16:24:52,174 - INFO -
2025-07-23 16:24:52,875 - DEBUG - Response for create_network : {'network': {'id': '6b273cf2-d9e9-4515-8984-0aa68a361043', 'name': 'ctest-vn-12964756', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'project_id': '5628bfbfc006466f91a913dc8e249356', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestStaticRouteTables-02371742', 'ctest-vn-12964756'], 'port_security_enabled': True, 'description': ''}}
2025-07-23 16:24:53,158 - DEBUG - Response for create_subnet : {'subnet': {'id': 'abdf9493-f825-4634-b14e-612a4d8d9cf7', 'name': '', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'network_id': '6b273cf2-d9e9-4515-8984-0aa68a361043', 'ip_version': 4, 'cidr': '196.199.106.192/26', 'allocation_pools': [{'start': '196.199.106.194', 'end': '196.199.106.254'}], 'gateway_ip': '196.199.106.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '196.199.106.194', 'tags': [], 'project_id': '5628bfbfc006466f91a913dc8e249356'}}
2025-07-23 16:24:53,182 - INFO - Created VN ctest-vn-12964756
2025-07-23 16:24:53,197 - DEBUG - VN ctest-vn-12964756 UUID is 6b273cf2-d9e9-4515-8984-0aa68a361043
2025-07-23 16:24:53,596 - DEBUG - Response for create_network : {'network': {'id': '6c44ed3c-bc3f-42e8-9651-fa8267050f8e', 'name': 'ctest-vn-82121186', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'project_id': '5628bfbfc006466f91a913dc8e249356', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestStaticRouteTables-02371742', 'ctest-vn-82121186'], 'port_security_enabled': True, 'description': ''}}
2025-07-23 16:24:53,846 - DEBUG - Response for create_subnet : {'subnet': {'id': 'e56f5c6e-7a37-46e9-9ba0-c3657b47c9ba', 'name': '', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'network_id': '6c44ed3c-bc3f-42e8-9651-fa8267050f8e', 'ip_version': 4, 'cidr': '174.39.26.128/26', 'allocation_pools': [{'start': '174.39.26.130', 'end': '174.39.26.190'}], 'gateway_ip': '174.39.26.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '174.39.26.130', 'tags': [], 'project_id': '5628bfbfc006466f91a913dc8e249356'}}
2025-07-23 16:24:53,870 - INFO - Created VN ctest-vn-82121186
2025-07-23 16:24:53,885 - DEBUG - VN ctest-vn-82121186 UUID is 6c44ed3c-bc3f-42e8-9651-fa8267050f8e
2025-07-23 16:24:54,036 - DEBUG - Services list from nova: [, , , ]
2025-07-23 16:24:55,160 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3704-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3704-2)
2025-07-23 16:24:56,471 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3704-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3704-1)
2025-07-23 16:24:56,471 - INFO - Waiting for VM ctest-TestStaticRouteTables-02371742-47160199 to be up..
2025-07-23 16:24:56,559 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2025-07-23 16:25:01,643 - DEBUG - VM is in ACTIVE state now
2025-07-23 16:25:01,643 - INFO - VM name : ctest-TestStaticRouteTables-02371742-47160199
2025-07-23 16:25:01,734 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 ID is f393e151-c84f-43c6-bcd8-a566bbf14797
2025-07-23 16:25:01,761 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 launched on Node an-jenkins-deploy-platform-ansible-os-3704-2
2025-07-23 16:25:01,868 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/f393e151-c84f-43c6-bcd8-a566bbf14797
2025-07-23 16:25:02,181 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/f393e151-c84f-43c6-bcd8-a566bbf14797
2025-07-23 16:25:02,216 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/27cbd6a6-9c1f-4322-9e26-451171e77e5b
2025-07-23 16:25:05,441 - 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 1007ms')
2025-07-23 16:25:05,441 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:05,462 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:09,543 - 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-07-23 16:25:09,543 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:09,560 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:13,632 - 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 1007ms')
2025-07-23 16:25:13,632 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:13,651 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:17,730 - 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 1018ms')
2025-07-23 16:25:17,730 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:17,746 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:21,828 - 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-07-23 16:25:21,828 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:21,844 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:25,918 - 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 1015ms')
2025-07-23 16:25:25,918 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:25,936 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:30,022 - 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-07-23 16:25:30,022 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 failed!
2025-07-23 16:25:30,039 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-12964756 is 196.199.106.193 and allocation pool is NOT set
2025-07-23 16:25:34,114 - 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=2 ttl=63 time=8.39 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 1 received, 50% packet loss, time 1015ms\r\nrtt min/avg/max/mdev = 8.387/8.387/8.387/0.000 ms')
2025-07-23 16:25:34,114 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-47160199 passed
2025-07-23 16:25:34,231 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:34,231 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-47160199, IP 196.199.106.195, Port 22
2025-07-23 16:25:34,298 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:25:34,388 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:25:39,389 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:39,389 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-47160199, IP 196.199.106.195, Port 22
2025-07-23 16:25:39,456 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:25:39,537 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:25:44,538 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:44,538 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-47160199, IP 196.199.106.195, Port 22
2025-07-23 16:25:44,607 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:25:44,700 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:25:49,700 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:49,701 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-47160199, IP 196.199.106.195, Port 22
2025-07-23 16:25:49,768 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:25:49,856 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:25:54,856 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:54,856 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-47160199, IP 196.199.106.195, Port 22
2025-07-23 16:25:55,013 - DEBUG - VM ctest-TestStaticRouteTables-02371742-47160199 is ready for SSH connections
2025-07-23 16:25:55,013 - INFO - Waiting for VM ctest-TestStaticRouteTables-02371742-41749317 to be up..
2025-07-23 16:25:55,143 - DEBUG - VM is in ACTIVE state now
2025-07-23 16:25:55,143 - INFO - VM name : ctest-TestStaticRouteTables-02371742-41749317
2025-07-23 16:25:55,274 - DEBUG - VM ctest-TestStaticRouteTables-02371742-41749317 ID is 9362262a-f780-48cd-96dc-1635cbad56b1
2025-07-23 16:25:55,274 - DEBUG - VM ctest-TestStaticRouteTables-02371742-41749317 launched on Node an-jenkins-deploy-platform-ansible-os-3704-1
2025-07-23 16:25:55,367 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/9362262a-f780-48cd-96dc-1635cbad56b1
2025-07-23 16:25:55,378 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/8c498977-fd39-4ae7-ae6b-ff55e91cb638
2025-07-23 16:25:56,673 - 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=6.24 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.646 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.646/3.445/6.244/2.799 ms')
2025-07-23 16:25:56,673 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-41749317 passed
2025-07-23 16:25:56,784 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:25:56,784 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-41749317, IP 174.39.26.131, Port 22
2025-07-23 16:25:56,972 - DEBUG - VM ctest-TestStaticRouteTables-02371742-41749317 is ready for SSH connections
2025-07-23 16:27:37,479 - DEBUG - Installing image ubuntu
2025-07-23 16:27:37,479 - DEBUG - Image info {'name': 'ubuntu.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'ubuntu', 'password': 'ubuntu', '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'}
2025-07-23 16:27:37,479 - DEBUG - Image build path file:///contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:27:37,480 - DEBUG - Download image from local file file:///contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:27:37,480 - DEBUG - Unzip image
2025-07-23 16:27:37,480 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:27:37,497 - DEBUG - Try to create image in user context
2025-07-23 16:27:37,572 - INFO - Deleting VM ctest-TestStaticRouteTables-02371742-41749317
2025-07-23 16:27:37,648 - INFO - Deleting VM ctest-TestStaticRouteTables-02371742-47160199
2025-07-23 16:27:37,715 - INFO - Deleting VN ctest-vn-82121186
2025-07-23 16:27:37,761 - DEBUG - VN 6c44ed3c-bc3f-42e8-9651-fa8267050f8e still in use: Unable to complete operation on network 6c44ed3c-bc3f-42e8-9651-fa8267050f8e. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-ab86f78c-ea20-4b6c-aea7-0a03cc4e9d74']
2025-07-23 16:27:37,761 - WARNING - Deleting VN ctest-vn-82121186 failed..Will retry
2025-07-23 16:27:39,962 - DEBUG - Response for deleting network ()
2025-07-23 16:27:39,963 - INFO - Deleting VN ctest-vn-12964756
2025-07-23 16:27:40,148 - DEBUG - Response for deleting network ()
2025-07-23 16:27:41,480 - ERROR - Traceback (most recent call last):
File "/contrail-test/tcutils/wrappers.py", line 80, in wrapper
result = function(self, *args, **kwargs)
File "/contrail-test/scripts/static_route_table/test_static_tables.py", line 30, in test_interface_static_table
self.config_basic()
File "/contrail-test/common/static_route_table/base.py", line 52, in config_basic
image_name='ubuntu', flavor='m1.tiny'))
File "/usr/local/lib/python3.6/site-packages/testtools/testcase.py", line 756, in useFixture
reraise(*exc_info)
File "/usr/local/lib/python3.6/site-packages/testtools/_compat3x.py", line 16, in reraise
raise exc_obj.with_traceback(exc_tb)
File "/usr/local/lib/python3.6/site-packages/testtools/testcase.py", line 731, in useFixture
fixture.setUp()
File "/contrail-test/fixtures/vm_test.py", line 188, in setUp
self.create()
File "/contrail-test/fixtures/vm_test.py", line 240, in create
fixed_ips=self.fixed_ips)
File "/contrail-test/fixtures/openstack.py", line 118, in create_vm
return self.nova_h.create_vm(vm_name=vm_name, image_name=image_name, vn_ids=vn_ids, **kwargs)
File "/contrail-test/fixtures/nova_test.py", line 580, in create_vm
image = self.get_image(image_name=image_name)
File "/contrail-test/fixtures/nova_test.py", line 199, in get_image
self._install_image(image_name=image_name)
File "/contrail-test/fixtures/nova_test.py", line 339, in _install_image
return self.copy_and_glance(build_path, image_name, params)
File "/contrail-test/fixtures/nova_test.py", line 410, in copy_and_glance
image_id = self.glance_h.create_image(generic_image_name, image_path_real, **params)
File "/contrail-test/fixtures/glance_test.py", line 50, in create_image
self.upload_image(obj['id'], filename)
File "/contrail-test/fixtures/glance_test.py", line 54, in upload_image
self.obj.images.upload(uuid, open(filename, 'rb'))
FileNotFoundError: [Errno 2] No such file or directory: '/contrail-test/images/ubuntu.vmdk'
2025-07-23 16:27:41,504 - DEBUG - No XMPP flaps were noticed during the test
2025-07-23 16:27:41,504 - INFO -
2025-07-23 16:27:41,504 - INFO - END TEST : test_interface_static_table : FAILED[0:02:51]
2025-07-23 16:27:41,504 - INFO - --------------------------------------------------------------------------------
2025-07-23 16:27:41,508 - INFO - ================================================================================
2025-07-23 16:27:41,508 - INFO - STARTING TEST : test_network_route_table
2025-07-23 16:27:41,508 - INFO - TEST DESCRIPTION :
Description: Validate network static table
Test steps:
1. Creating vm's - vm1 and vm2 and middle vm in networks vn1 and vn2.
2. Creating network static table betn left and right vm
3. Apply static table to the middle ports.
4. Checking for ping and tcp traffic between vm1 and vm2.
Pass criteria: Ping between the VMs should be successful and route should be in the agent
2025-07-23 16:27:42,869 - DEBUG - Nothing to compare xmpp stats {'10.0.0.50': {'10.20.0.254': '0', '10.20.0.17': '0'}, '10.0.0.130': {'10.20.0.17': '0', '10.20.0.254': '0'}} with
2025-07-23 16:27:42,869 - INFO - Initial checks done. Running the testcase now
2025-07-23 16:27:42,869 - INFO -
2025-07-23 16:27:43,166 - DEBUG - Response for create_network : {'network': {'id': '23ce3d51-db31-422a-9bcc-b90225b078f2', 'name': 'ctest-vn-70566960', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'project_id': '5628bfbfc006466f91a913dc8e249356', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestStaticRouteTables-02371742', 'ctest-vn-70566960'], 'port_security_enabled': True, 'description': ''}}
2025-07-23 16:27:43,431 - DEBUG - Response for create_subnet : {'subnet': {'id': 'da0fe6ca-8bc0-4292-abcb-e90cf2f73324', 'name': '', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'network_id': '23ce3d51-db31-422a-9bcc-b90225b078f2', 'ip_version': 4, 'cidr': '219.187.228.64/26', 'allocation_pools': [{'start': '219.187.228.66', 'end': '219.187.228.126'}], 'gateway_ip': '219.187.228.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '219.187.228.66', 'tags': [], 'project_id': '5628bfbfc006466f91a913dc8e249356'}}
2025-07-23 16:27:43,453 - INFO - Created VN ctest-vn-70566960
2025-07-23 16:27:43,466 - DEBUG - VN ctest-vn-70566960 UUID is 23ce3d51-db31-422a-9bcc-b90225b078f2
2025-07-23 16:27:43,874 - DEBUG - Response for create_network : {'network': {'id': 'ac4eb7d7-3656-46d4-aa62-0f4785cf5873', 'name': 'ctest-vn-15529084', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'project_id': '5628bfbfc006466f91a913dc8e249356', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestStaticRouteTables-02371742', 'ctest-vn-15529084'], 'port_security_enabled': True, 'description': ''}}
2025-07-23 16:27:44,101 - DEBUG - Response for create_subnet : {'subnet': {'id': 'd439a799-8195-4a69-92e6-807e198b33f8', 'name': '', 'tenant_id': '5628bfbfc006466f91a913dc8e249356', 'network_id': 'ac4eb7d7-3656-46d4-aa62-0f4785cf5873', 'ip_version': 4, 'cidr': '202.35.114.128/26', 'allocation_pools': [{'start': '202.35.114.130', 'end': '202.35.114.190'}], 'gateway_ip': '202.35.114.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '202.35.114.130', 'tags': [], 'project_id': '5628bfbfc006466f91a913dc8e249356'}}
2025-07-23 16:27:44,129 - INFO - Created VN ctest-vn-15529084
2025-07-23 16:27:44,149 - DEBUG - VN ctest-vn-15529084 UUID is ac4eb7d7-3656-46d4-aa62-0f4785cf5873
2025-07-23 16:27:45,438 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3704-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3704-1)
2025-07-23 16:27:47,021 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-3704-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-3704-2)
2025-07-23 16:27:47,022 - INFO - Waiting for VM ctest-TestStaticRouteTables-02371742-88038126 to be up..
2025-07-23 16:27:47,111 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2025-07-23 16:27:52,202 - DEBUG - VM is in ACTIVE state now
2025-07-23 16:27:52,202 - INFO - VM name : ctest-TestStaticRouteTables-02371742-88038126
2025-07-23 16:27:52,288 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 ID is effebe0d-d25d-4ae5-992b-e428bd470e09
2025-07-23 16:27:52,288 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 launched on Node an-jenkins-deploy-platform-ansible-os-3704-1
2025-07-23 16:27:52,372 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/effebe0d-d25d-4ae5-992b-e428bd470e09
2025-07-23 16:27:52,385 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/3bfe7c35-fe65-46eb-a49f-5f3eb04b2595
2025-07-23 16:27:55,726 - 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 1017ms')
2025-07-23 16:27:55,726 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:27:55,741 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:27:59,852 - 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 1030ms')
2025-07-23 16:27:59,852 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:27:59,868 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:03,981 - 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 1030ms')
2025-07-23 16:28:03,981 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:03,997 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:08,073 - 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 1014ms')
2025-07-23 16:28:08,073 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:08,091 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:12,204 - 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 1031ms')
2025-07-23 16:28:12,204 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:12,219 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:16,300 - 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 1012ms')
2025-07-23 16:28:16,301 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:16,321 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:20,401 - 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 1012ms')
2025-07-23 16:28:20,401 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:20,418 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:24,523 - 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-07-23 16:28:24,524 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 failed!
2025-07-23 16:28:24,541 - DEBUG - Gateway for vn default-domain:ctest-TestStaticRouteTables-02371742:ctest-vn-70566960 is 219.187.228.65 and allocation pool is NOT set
2025-07-23 16:28:26,640 - 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=6.28 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=1.19 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 = 1.193/3.738/6.283/2.545 ms')
2025-07-23 16:28:26,640 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-88038126 passed
2025-07-23 16:28:26,759 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:26,759 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-88038126, IP 219.187.228.67, Port 22
2025-07-23 16:28:26,849 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:28:26,938 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:28:31,939 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:31,939 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-88038126, IP 219.187.228.67, Port 22
2025-07-23 16:28:32,029 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:28:32,123 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:28:37,123 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:37,123 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-88038126, IP 219.187.228.67, Port 22
2025-07-23 16:28:37,203 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:28:37,288 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:28:42,289 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:42,289 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-88038126, IP 219.187.228.67, Port 22
2025-07-23 16:28:42,381 - DEBUG - Error on ssh to ubuntu@169.254.0.3:22, result: /bin/bash: connect: Connection refused
/bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''}
2025-07-23 16:28:42,497 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 is NOT ready for SSH connections, VM status: ACTIVE
2025-07-23 16:28:47,498 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:47,498 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-88038126, IP 219.187.228.67, Port 22
2025-07-23 16:28:47,680 - DEBUG - VM ctest-TestStaticRouteTables-02371742-88038126 is ready for SSH connections
2025-07-23 16:28:47,680 - INFO - Waiting for VM ctest-TestStaticRouteTables-02371742-03481538 to be up..
2025-07-23 16:28:47,777 - DEBUG - VM is in ACTIVE state now
2025-07-23 16:28:47,777 - INFO - VM name : ctest-TestStaticRouteTables-02371742-03481538
2025-07-23 16:28:47,860 - DEBUG - VM ctest-TestStaticRouteTables-02371742-03481538 ID is 34528869-8a9e-4c32-9b29-1e64b856567c
2025-07-23 16:28:47,860 - DEBUG - VM ctest-TestStaticRouteTables-02371742-03481538 launched on Node an-jenkins-deploy-platform-ansible-os-3704-2
2025-07-23 16:28:47,956 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/34528869-8a9e-4c32-9b29-1e64b856567c
2025-07-23 16:28:47,970 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/cc60755f-f05f-4f10-82db-5b86ddfb50b8
2025-07-23 16:28:49,184 - 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.46 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.530 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.530/2.497/4.464/1.967 ms')
2025-07-23 16:28:49,184 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-TestStaticRouteTables-02371742-03481538 passed
2025-07-23 16:28:49,302 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-23 16:28:49,302 - DEBUG - Waiting to SSH to VM ctest-TestStaticRouteTables-02371742-03481538, IP 202.35.114.131, Port 22
2025-07-23 16:28:49,467 - DEBUG - VM ctest-TestStaticRouteTables-02371742-03481538 is ready for SSH connections
2025-07-23 16:30:30,017 - DEBUG - Installing image ubuntu
2025-07-23 16:30:30,017 - DEBUG - Image info {'name': 'ubuntu.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'ubuntu', 'password': 'ubuntu', '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'}
2025-07-23 16:30:30,017 - DEBUG - Image build path file:///contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:30:30,017 - DEBUG - Download image from local file file:///contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:30:30,017 - DEBUG - Unzip image
2025-07-23 16:30:30,017 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/ubuntu.vmdk.gz
2025-07-23 16:30:30,041 - DEBUG - Try to create image in user context
2025-07-23 16:30:30,105 - INFO - Deleting VM ctest-TestStaticRouteTables-02371742-03481538
2025-07-23 16:30:30,189 - INFO - Deleting VM ctest-TestStaticRouteTables-02371742-88038126
2025-07-23 16:30:30,268 - INFO - Deleting VN ctest-vn-15529084
2025-07-23 16:30:30,377 - DEBUG - VN ac4eb7d7-3656-46d4-aa62-0f4785cf5873 still in use: Unable to complete operation on network ac4eb7d7-3656-46d4-aa62-0f4785cf5873. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-307456d8-37ec-4154-82d1-f17072e9d182']
2025-07-23 16:30:30,377 - WARNING - Deleting VN ctest-vn-15529084 failed..Will retry
2025-07-23 16:30:32,586 - DEBUG - Response for deleting network ()
2025-07-23 16:30:32,587 - INFO - Deleting VN ctest-vn-70566960
2025-07-23 16:30:32,791 - DEBUG - Response for deleting network ()
2025-07-23 16:30:34,090 - ERROR - Traceback (most recent call last):
File "/contrail-test/tcutils/wrappers.py", line 80, in wrapper
result = function(self, *args, **kwargs)
File "/contrail-test/scripts/static_route_table/test_static_tables.py", line 170, in test_network_route_table
self.config_basic()
File "/contrail-test/common/static_route_table/base.py", line 52, in config_basic
image_name='ubuntu', flavor='m1.tiny'))
File "/usr/local/lib/python3.6/site-packages/testtools/testcase.py", line 756, in useFixture
reraise(*exc_info)
File "/usr/local/lib/python3.6/site-packages/testtools/_compat3x.py", line 16, in reraise
raise exc_obj.with_traceback(exc_tb)
File "/usr/local/lib/python3.6/site-packages/testtools/testcase.py", line 731, in useFixture
fixture.setUp()
File "/contrail-test/fixtures/vm_test.py", line 188, in setUp
self.create()
File "/contrail-test/fixtures/vm_test.py", line 240, in create
fixed_ips=self.fixed_ips)
File "/contrail-test/fixtures/openstack.py", line 118, in create_vm
return self.nova_h.create_vm(vm_name=vm_name, image_name=image_name, vn_ids=vn_ids, **kwargs)
File "/contrail-test/fixtures/nova_test.py", line 580, in create_vm
image = self.get_image(image_name=image_name)
File "/contrail-test/fixtures/nova_test.py", line 199, in get_image
self._install_image(image_name=image_name)
File "/contrail-test/fixtures/nova_test.py", line 339, in _install_image
return self.copy_and_glance(build_path, image_name, params)
File "/contrail-test/fixtures/nova_test.py", line 410, in copy_and_glance
image_id = self.glance_h.create_image(generic_image_name, image_path_real, **params)
File "/contrail-test/fixtures/glance_test.py", line 50, in create_image
self.upload_image(obj['id'], filename)
File "/contrail-test/fixtures/glance_test.py", line 54, in upload_image
self.obj.images.upload(uuid, open(filename, 'rb'))
FileNotFoundError: [Errno 2] No such file or directory: '/contrail-test/images/ubuntu.vmdk'
2025-07-23 16:30:34,116 - DEBUG - No XMPP flaps were noticed during the test
2025-07-23 16:30:34,116 - INFO -
2025-07-23 16:30:34,117 - INFO - END TEST : test_network_route_table : FAILED[0:02:53]
2025-07-23 16:30:34,117 - INFO - --------------------------------------------------------------------------------
2025-07-23 16:30:34,893 - INFO - Deleted project: ctest-TestStaticRouteTables-02371742, ID : 5628bfbf-c006-466f-91a9-13dc8e249356