yahoo-eng-team team mailing list archive

Thread
Date
[Bug 1575316] [NEW] Functional job failures in pecan tests

To: yahoo-eng-team@xxxxxxxxxxxxxxxxxxx
From: Henry Gessau <HenryG@xxxxxxxxxx>
Date: Tue, 26 Apr 2016 18:53:36 -0000
Reply-to: Bug 1575316 <1575316@xxxxxxxxxxxxxxxxxx>
Sender: bounces@xxxxxxxxxxxxx
Public bug reported:

Examples:


2016-04-26 14:40:22.082 | 2016-04-26 14:40:22.054 | ==============================
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.056 | Failed 2 tests - output below:
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.057 | ==============================
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.059 | 
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.061 | neutron.tests.functional.pecan_wsgi.test_controllers.TestQuotasController.test_get
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.063 | ----------------------------------------------------------------------------------
2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.065 | 
2016-04-26 14:40:22.084 | 2016-04-26 14:40:22.066 | Captured pythonlogging:
2016-04-26 14:40:22.084 | 2016-04-26 14:40:22.068 | ~~~~~~~~~~~~~~~~~~~~~~~
2016-04-26 14:40:22.085 | 2016-04-26 14:40:22.070 |         INFO [neutron.plugins.ml2.managers] Configured type driver names: ['local', 'flat', 'vlan', 'gre', 'vxlan', 'geneve']
2016-04-26 14:40:22.087 | 2016-04-26 14:40:22.072 |         INFO [neutron.plugins.ml2.drivers.type_flat] Arbitrary flat physical_network names allowed
2016-04-26 14:40:22.088 | 2016-04-26 14:40:22.074 |         INFO [neutron.plugins.ml2.drivers.type_vlan] Network VLAN ranges: {}
2016-04-26 14:40:22.090 | 2016-04-26 14:40:22.076 |         INFO [neutron.plugins.ml2.drivers.type_local] ML2 LocalTypeDriver initialization complete
2016-04-26 14:40:22.092 | 2016-04-26 14:40:22.077 |         INFO [neutron.plugins.ml2.managers] Loaded type driver names: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
2016-04-26 14:40:22.094 | 2016-04-26 14:40:22.079 |         INFO [neutron.plugins.ml2.managers] Registered types: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
2016-04-26 14:40:22.095 | 2016-04-26 14:40:22.081 |         INFO [neutron.plugins.ml2.managers] Tenant network_types: ['local']
2016-04-26 14:40:22.097 | 2016-04-26 14:40:22.083 |         INFO [neutron.plugins.ml2.managers] Configured extension driver names: []
2016-04-26 14:40:22.099 | 2016-04-26 14:40:22.084 |         INFO [neutron.plugins.ml2.managers] Loaded extension driver names: []
2016-04-26 14:40:22.101 | 2016-04-26 14:40:22.086 |         INFO [neutron.plugins.ml2.managers] Registered extension drivers: []
2016-04-26 14:40:22.102 | 2016-04-26 14:40:22.088 |         INFO [neutron.plugins.ml2.managers] Configured mechanism driver names: []
2016-04-26 14:40:22.104 | 2016-04-26 14:40:22.090 |         INFO [neutron.plugins.ml2.managers] Loaded mechanism driver names: []
2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.091 |         INFO [neutron.plugins.ml2.managers] Registered mechanism drivers: []
2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.093 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'geneve'
2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.095 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] geneve ID ranges: []
2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.097 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'flat'
2016-04-26 14:40:22.116 | 2016-04-26 14:40:22.098 |         INFO [neutron.plugins.ml2.drivers.type_flat] ML2 FlatTypeDriver initialization complete
2016-04-26 14:40:22.116 | 2016-04-26 14:40:22.100 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vlan'
2016-04-26 14:40:22.117 | 2016-04-26 14:40:22.102 |         INFO [neutron.plugins.ml2.drivers.type_vlan] VlanTypeDriver initialization complete
2016-04-26 14:40:22.118 | 2016-04-26 14:40:22.104 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'gre'
2016-04-26 14:40:22.120 | 2016-04-26 14:40:22.105 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] gre ID ranges: []
2016-04-26 14:40:22.122 | 2016-04-26 14:40:22.107 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'local'
2016-04-26 14:40:22.123 | 2016-04-26 14:40:22.109 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vxlan'
2016-04-26 14:40:22.125 | 2016-04-26 14:40:22.110 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] vxlan ID ranges: []
2016-04-26 14:40:22.127 | 2016-04-26 14:40:22.112 |         INFO [neutron.plugins.ml2.plugin] Modular L2 Plugin initialization complete
2016-04-26 14:40:22.129 | 2016-04-26 14:40:22.114 |         INFO [neutron.extensions.vlantransparent] Disabled vlantransparent extension.
2016-04-26 14:40:22.130 | 2016-04-26 14:40:22.116 |         INFO [neutron.pecan_wsgi.startup] Extension Quota management support is pecan-aware. Fetching resources and controllers
2016-04-26 14:40:22.132 | 2016-04-26 14:40:22.118 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource address_scope via URI path segment:address_scopes
2016-04-26 14:40:22.134 | 2016-04-26 14:40:22.119 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource network via URI path segment:networks
2016-04-26 14:40:22.135 | 2016-04-26 14:40:22.121 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource rbac_policy via URI path segment:rbac_policies
2016-04-26 14:40:22.137 | 2016-04-26 14:40:22.122 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group via URI path segment:security_groups
2016-04-26 14:40:22.139 | 2016-04-26 14:40:22.124 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: quotas
2016-04-26 14:40:22.140 | 2016-04-26 14:40:22.126 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:quota. API calls may not be correctly dispatched
2016-04-26 14:40:22.142 | 2016-04-26 14:40:22.127 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource quota via URI path segment:quotas
2016-04-26 14:40:22.144 | 2016-04-26 14:40:22.129 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource port via URI path segment:ports
2016-04-26 14:40:22.146 | 2016-04-26 14:40:22.131 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: routers
2016-04-26 14:40:22.147 | 2016-04-26 14:40:22.133 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:router. API calls may not be correctly dispatched
2016-04-26 14:40:22.149 | 2016-04-26 14:40:22.134 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource router via URI path segment:routers
2016-04-26 14:40:22.150 | 2016-04-26 14:40:22.136 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group_rule via URI path segment:security_group_rules
2016-04-26 14:40:22.152 | 2016-04-26 14:40:22.137 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource agent via URI path segment:agents
2016-04-26 14:40:22.154 | 2016-04-26 14:40:22.139 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: floatingips
2016-04-26 14:40:22.155 | 2016-04-26 14:40:22.140 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:floatingip. API calls may not be correctly dispatched
2016-04-26 14:40:22.156 | 2016-04-26 14:40:22.142 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource floatingip via URI path segment:floatingips
2016-04-26 14:40:22.158 | 2016-04-26 14:40:22.144 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnet via URI path segment:subnets
2016-04-26 14:40:22.160 | 2016-04-26 14:40:22.145 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnetpool via URI path segment:subnetpools
2016-04-26 14:40:22.162 | 2016-04-26 14:40:22.147 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource availability_zone via URI path segment:availability_zones
2016-04-26 14:40:22.164 | 2016-04-26 14:40:22.149 |     
2016-04-26 14:40:22.166 | 2016-04-26 14:40:22.151 | 
2016-04-26 14:40:22.167 | 2016-04-26 14:40:22.153 | Captured traceback:
2016-04-26 14:40:22.169 | 2016-04-26 14:40:22.155 | ~~~~~~~~~~~~~~~~~~~
2016-04-26 14:40:22.171 | 2016-04-26 14:40:22.156 |     Traceback (most recent call last):
2016-04-26 14:40:22.173 | 2016-04-26 14:40:22.158 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 206, in test_get
2016-04-26 14:40:22.175 | 2016-04-26 14:40:22.160 |         self._verify_default_limits(json_body)
2016-04-26 14:40:22.176 | 2016-04-26 14:40:22.162 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 167, in _verify_default_limits
2016-04-26 14:40:22.178 | 2016-04-26 14:40:22.164 |         self._verify_limits(response, self.default_expected_limits)
2016-04-26 14:40:22.180 | 2016-04-26 14:40:22.166 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 164, in _verify_limits
2016-04-26 14:40:22.182 | 2016-04-26 14:40:22.168 |         self.assertEqual(limit, response['quota'][resource])
2016-04-26 14:40:22.184 | 2016-04-26 14:40:22.169 |     KeyError: 'subnet'
2016-04-26 14:40:22.186 | 2016-04-26 14:40:22.171 |     
2016-04-26 14:40:22.188 | 2016-04-26 14:40:22.173 | 
2016-04-26 14:40:22.189 | 2016-04-26 14:40:22.175 | Captured stderr:
2016-04-26 14:40:22.191 | 2016-04-26 14:40:22.177 | ~~~~~~~~~~~~~~~~
2016-04-26 14:40:22.193 | 2016-04-26 14:40:22.178 |     /opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_db/sqlalchemy/enginefacade.py:1056: OsloDBDeprecationWarning: EngineFacade is deprecated; please use oslo_db.sqlalchemy.enginefacade
2016-04-26 14:40:22.194 | 2016-04-26 14:40:22.180 |       expire_on_commit=expire_on_commit, _conf=conf)
2016-04-26 14:40:22.196 | 2016-04-26 14:40:22.182 |     neutron/pecan_wsgi/hooks/policy_enforcement.py:166: DeprecationWarning: BaseException.message has been deprecated as of Python 2.6
2016-04-26 14:40:22.198 | 2016-04-26 14:40:22.183 |       raise webob.exc.HTTPForbidden(e.message)
2016-04-26 14:40:22.199 | 2016-04-26 14:40:22.185 |     
2016-04-26 14:40:22.201 | 2016-04-26 14:40:22.187 | 
2016-04-26 14:40:22.203 | 2016-04-26 14:40:22.189 | neutron.tests.functional.pecan_wsgi.test_hooks.TestPolicyEnforcementHook.test_after_on_get_excludes_admin_attribute
2016-04-26 14:40:22.205 | 2016-04-26 14:40:22.191 | -------------------------------------------------------------------------------------------------------------------
2016-04-26 14:40:22.207 | 2016-04-26 14:40:22.192 | 
2016-04-26 14:40:22.208 | 2016-04-26 14:40:22.194 | Captured pythonlogging:
2016-04-26 14:40:22.210 | 2016-04-26 14:40:22.196 | ~~~~~~~~~~~~~~~~~~~~~~~
2016-04-26 14:40:22.212 | 2016-04-26 14:40:22.197 |         INFO [neutron.plugins.ml2.managers] Configured type driver names: ['local', 'flat', 'vlan', 'gre', 'vxlan', 'geneve']
2016-04-26 14:40:22.213 | 2016-04-26 14:40:22.199 |         INFO [neutron.plugins.ml2.drivers.type_flat] Arbitrary flat physical_network names allowed
2016-04-26 14:40:22.215 | 2016-04-26 14:40:22.201 |         INFO [neutron.plugins.ml2.drivers.type_vlan] Network VLAN ranges: {}
2016-04-26 14:40:22.217 | 2016-04-26 14:40:22.202 |         INFO [neutron.plugins.ml2.drivers.type_local] ML2 LocalTypeDriver initialization complete
2016-04-26 14:40:22.218 | 2016-04-26 14:40:22.204 |         INFO [neutron.plugins.ml2.managers] Loaded type driver names: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
2016-04-26 14:40:22.220 | 2016-04-26 14:40:22.205 |         INFO [neutron.plugins.ml2.managers] Registered types: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
2016-04-26 14:40:22.221 | 2016-04-26 14:40:22.207 |         INFO [neutron.plugins.ml2.managers] Tenant network_types: ['local']
2016-04-26 14:40:22.223 | 2016-04-26 14:40:22.209 |         INFO [neutron.plugins.ml2.managers] Configured extension driver names: []
2016-04-26 14:40:22.225 | 2016-04-26 14:40:22.210 |         INFO [neutron.plugins.ml2.managers] Loaded extension driver names: []
2016-04-26 14:40:22.226 | 2016-04-26 14:40:22.212 |         INFO [neutron.plugins.ml2.managers] Registered extension drivers: []
2016-04-26 14:40:22.228 | 2016-04-26 14:40:22.213 |         INFO [neutron.plugins.ml2.managers] Configured mechanism driver names: []
2016-04-26 14:40:22.229 | 2016-04-26 14:40:22.215 |         INFO [neutron.plugins.ml2.managers] Loaded mechanism driver names: []
2016-04-26 14:40:22.231 | 2016-04-26 14:40:22.217 |         INFO [neutron.plugins.ml2.managers] Registered mechanism drivers: []
2016-04-26 14:40:22.233 | 2016-04-26 14:40:22.218 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'geneve'
2016-04-26 14:40:22.234 | 2016-04-26 14:40:22.220 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] geneve ID ranges: []
2016-04-26 14:40:22.236 | 2016-04-26 14:40:22.221 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'flat'
2016-04-26 14:40:22.237 | 2016-04-26 14:40:22.223 |         INFO [neutron.plugins.ml2.drivers.type_flat] ML2 FlatTypeDriver initialization complete
2016-04-26 14:40:22.239 | 2016-04-26 14:40:22.224 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vlan'
2016-04-26 14:40:22.240 | 2016-04-26 14:40:22.226 |         INFO [neutron.plugins.ml2.drivers.type_vlan] VlanTypeDriver initialization complete
2016-04-26 14:40:22.242 | 2016-04-26 14:40:22.228 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'gre'
2016-04-26 14:40:22.244 | 2016-04-26 14:40:22.229 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] gre ID ranges: []
2016-04-26 14:40:22.245 | 2016-04-26 14:40:22.231 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'local'
2016-04-26 14:40:22.247 | 2016-04-26 14:40:22.232 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vxlan'
2016-04-26 14:40:22.248 | 2016-04-26 14:40:22.234 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] vxlan ID ranges: []
2016-04-26 14:40:22.250 | 2016-04-26 14:40:22.235 |         INFO [neutron.plugins.ml2.plugin] Modular L2 Plugin initialization complete
2016-04-26 14:40:22.251 | 2016-04-26 14:40:22.237 |         INFO [neutron.extensions.vlantransparent] Disabled vlantransparent extension.
2016-04-26 14:40:22.253 | 2016-04-26 14:40:22.239 |         INFO [neutron.pecan_wsgi.startup] Extension Quota management support is pecan-aware. Fetching resources and controllers
2016-04-26 14:40:22.255 | 2016-04-26 14:40:22.240 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource address_scope via URI path segment:address_scopes
2016-04-26 14:40:22.256 | 2016-04-26 14:40:22.242 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource network via URI path segment:networks
2016-04-26 14:40:22.258 | 2016-04-26 14:40:22.243 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource rbac_policy via URI path segment:rbac_policies
2016-04-26 14:40:22.259 | 2016-04-26 14:40:22.245 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group via URI path segment:security_groups
2016-04-26 14:40:22.261 | 2016-04-26 14:40:22.246 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: quotas
2016-04-26 14:40:22.262 | 2016-04-26 14:40:22.248 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:quota. API calls may not be correctly dispatched
2016-04-26 14:40:22.264 | 2016-04-26 14:40:22.250 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource quota via URI path segment:quotas
2016-04-26 14:40:22.266 | 2016-04-26 14:40:22.251 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: routers
2016-04-26 14:40:22.267 | 2016-04-26 14:40:22.253 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:router. API calls may not be correctly dispatched
2016-04-26 14:40:22.269 | 2016-04-26 14:40:22.254 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource router via URI path segment:routers
2016-04-26 14:40:22.270 | 2016-04-26 14:40:22.256 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource port via URI path segment:ports
2016-04-26 14:40:22.272 | 2016-04-26 14:40:22.258 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group_rule via URI path segment:security_group_rules
2016-04-26 14:40:22.274 | 2016-04-26 14:40:22.259 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource agent via URI path segment:agents
2016-04-26 14:40:22.275 | 2016-04-26 14:40:22.261 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: floatingips
2016-04-26 14:40:22.277 | 2016-04-26 14:40:22.263 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:floatingip. API calls may not be correctly dispatched
2016-04-26 14:40:22.279 | 2016-04-26 14:40:22.264 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource floatingip via URI path segment:floatingips
2016-04-26 14:40:22.280 | 2016-04-26 14:40:22.266 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnet via URI path segment:subnets
2016-04-26 14:40:22.282 | 2016-04-26 14:40:22.267 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnetpool via URI path segment:subnetpools
2016-04-26 14:40:22.283 | 2016-04-26 14:40:22.269 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource availability_zone via URI path segment:availability_zones
2016-04-26 14:40:22.285 | 2016-04-26 14:40:22.271 |     
2016-04-26 14:40:22.287 | 2016-04-26 14:40:22.272 | 
2016-04-26 14:40:22.288 | 2016-04-26 14:40:22.274 | Captured traceback:
2016-04-26 14:40:22.290 | 2016-04-26 14:40:22.276 | ~~~~~~~~~~~~~~~~~~~
2016-04-26 14:40:22.292 | 2016-04-26 14:40:22.277 |     Traceback (most recent call last):
2016-04-26 14:40:22.293 | 2016-04-26 14:40:22.279 |       File "neutron/tests/functional/pecan_wsgi/test_hooks.py", line 206, in test_after_on_get_excludes_admin_attribute
2016-04-26 14:40:22.295 | 2016-04-26 14:40:22.281 |         headers={'X-Project-Id': 'tenid'})
2016-04-26 14:40:22.297 | 2016-04-26 14:40:22.282 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/app.py", line 327, in get
2016-04-26 14:40:22.298 | 2016-04-26 14:40:22.284 |         expect_errors=expect_errors)
2016-04-26 14:40:22.300 | 2016-04-26 14:40:22.285 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/app.py", line 610, in do_request
2016-04-26 14:40:22.302 | 2016-04-26 14:40:22.287 |         res = req.get_response(app, catch_exc_info=True)
2016-04-26 14:40:22.303 | 2016-04-26 14:40:22.289 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1295, in send
2016-04-26 14:40:22.305 | 2016-04-26 14:40:22.290 |         application, catch_exc_info=True)
2016-04-26 14:40:22.306 | 2016-04-26 14:40:22.292 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
2016-04-26 14:40:22.308 | 2016-04-26 14:40:22.294 |         app_iter = application(self.environ, start_response)
2016-04-26 14:40:22.310 | 2016-04-26 14:40:22.295 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/lint.py", line 198, in lint_app
2016-04-26 14:40:22.311 | 2016-04-26 14:40:22.297 |         iterator = application(environ, start_response_wrapper)
2016-04-26 14:40:22.313 | 2016-04-26 14:40:22.298 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/middleware/recursive.py", line 56, in __call__
2016-04-26 14:40:22.314 | 2016-04-26 14:40:22.300 |         return self.application(environ, start_response)
2016-04-26 14:40:22.316 | 2016-04-26 14:40:22.302 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/middleware/errordocument.py", line 75, in __call__
2016-04-26 14:40:22.318 | 2016-04-26 14:40:22.303 |         app_iter = self.app(environ, replacement_start_response)
2016-04-26 14:40:22.319 | 2016-04-26 14:40:22.305 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
2016-04-26 14:40:22.321 | 2016-04-26 14:40:22.306 |         resp = self.call_func(req, *args, **self.kwargs)
2016-04-26 14:40:22.323 | 2016-04-26 14:40:22.308 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
2016-04-26 14:40:22.325 | 2016-04-26 14:40:22.310 |         return self.func(req, *args, **kwargs)
2016-04-26 14:40:22.326 | 2016-04-26 14:40:22.312 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_middleware/base.py", line 114, in __call__
2016-04-26 14:40:22.328 | 2016-04-26 14:40:22.313 |         response = req.get_response(self.application)
2016-04-26 14:40:22.329 | 2016-04-26 14:40:22.315 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
2016-04-26 14:40:22.331 | 2016-04-26 14:40:22.316 |         application, catch_exc_info=False)
2016-04-26 14:40:22.332 | 2016-04-26 14:40:22.318 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
2016-04-26 14:40:22.334 | 2016-04-26 14:40:22.320 |         app_iter = application(self.environ, start_response)
2016-04-26 14:40:22.336 | 2016-04-26 14:40:22.321 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
2016-04-26 14:40:22.337 | 2016-04-26 14:40:22.323 |         resp = self.call_func(req, *args, **self.kwargs)
2016-04-26 14:40:22.339 | 2016-04-26 14:40:22.324 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
2016-04-26 14:40:22.340 | 2016-04-26 14:40:22.326 |         return self.func(req, *args, **kwargs)
2016-04-26 14:40:22.342 | 2016-04-26 14:40:22.327 |       File "neutron/api/versions.py", line 42, in __call__
2016-04-26 14:40:22.343 | 2016-04-26 14:40:22.329 |         return req.get_response(self.app)
2016-04-26 14:40:22.345 | 2016-04-26 14:40:22.331 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
2016-04-26 14:40:22.347 | 2016-04-26 14:40:22.332 |         application, catch_exc_info=False)
2016-04-26 14:40:22.348 | 2016-04-26 14:40:22.334 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
2016-04-26 14:40:22.350 | 2016-04-26 14:40:22.335 |         app_iter = application(self.environ, start_response)
2016-04-26 14:40:22.351 | 2016-04-26 14:40:22.337 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
2016-04-26 14:40:22.353 | 2016-04-26 14:40:22.339 |         resp = self.call_func(req, *args, **self.kwargs)
2016-04-26 14:40:22.355 | 2016-04-26 14:40:22.340 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
2016-04-26 14:40:22.356 | 2016-04-26 14:40:22.342 |         return self.func(req, *args, **kwargs)
2016-04-26 14:40:22.358 | 2016-04-26 14:40:22.344 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_middleware/request_id.py", line 37, in __call__
2016-04-26 14:40:22.360 | 2016-04-26 14:40:22.346 |         response = req.get_response(self.application)
2016-04-26 14:40:22.362 | 2016-04-26 14:40:22.347 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
2016-04-26 14:40:22.363 | 2016-04-26 14:40:22.349 |         application, catch_exc_info=False)
2016-04-26 14:40:22.365 | 2016-04-26 14:40:22.351 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
2016-04-26 14:40:22.367 | 2016-04-26 14:40:22.352 |         app_iter = application(self.environ, start_response)
2016-04-26 14:40:22.369 | 2016-04-26 14:40:22.354 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 829, in __call__
2016-04-26 14:40:22.371 | 2016-04-26 14:40:22.356 |         return super(Pecan, self).__call__(environ, start_response)
2016-04-26 14:40:22.373 | 2016-04-26 14:40:22.358 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 725, in __call__
2016-04-26 14:40:22.374 | 2016-04-26 14:40:22.360 |         self.determine_hooks(state.controller), 'after', state
2016-04-26 14:40:22.376 | 2016-04-26 14:40:22.361 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 854, in handle_hooks
2016-04-26 14:40:22.377 | 2016-04-26 14:40:22.363 |         return super(Pecan, self).handle_hooks(hooks, *args, **kw)
2016-04-26 14:40:22.379 | 2016-04-26 14:40:22.364 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 345, in handle_hooks
2016-04-26 14:40:22.380 | 2016-04-26 14:40:22.366 |         result = getattr(hook, hook_type)(*args)
2016-04-26 14:40:22.382 | 2016-04-26 14:40:22.368 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 161, in after
2016-04-26 14:40:22.383 | 2016-04-26 14:40:22.369 |         pluralized=collection))]
2016-04-26 14:40:22.385 | 2016-04-26 14:40:22.371 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 175, in _get_filtered_item
2016-04-26 14:40:22.387 | 2016-04-26 14:40:22.372 |         neutron_context, resource, collection, data)
2016-04-26 14:40:22.388 | 2016-04-26 14:40:22.374 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 198, in _exclude_attributes_by_policy
2016-04-26 14:40:22.390 | 2016-04-26 14:40:22.376 |         resource).get(attr_name)
2016-04-26 14:40:22.393 | 2016-04-26 14:40:22.378 |     AttributeError: 'NoneType' object has no attribute 'get'
2016-04-26 14:40:22.394 | 2016-04-26 14:40:22.380 |

** Affects: neutron
     Importance: Critical
         Status: New


** Tags: gate-failure

** Changed in: neutron
   Importance: Undecided => Critical

** Tags added: gate-failure

-- 
You received this bug notification because you are a member of Yahoo!
Engineering Team, which is subscribed to neutron.
https://bugs.launchpad.net/bugs/1575316

Title:
  Functional job failures in pecan tests

Status in neutron:
  New

Bug description:
  Examples:

  
  2016-04-26 14:40:22.082 | 2016-04-26 14:40:22.054 | ==============================
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.056 | Failed 2 tests - output below:
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.057 | ==============================
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.059 | 
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.061 | neutron.tests.functional.pecan_wsgi.test_controllers.TestQuotasController.test_get
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.063 | ----------------------------------------------------------------------------------
  2016-04-26 14:40:22.083 | 2016-04-26 14:40:22.065 | 
  2016-04-26 14:40:22.084 | 2016-04-26 14:40:22.066 | Captured pythonlogging:
  2016-04-26 14:40:22.084 | 2016-04-26 14:40:22.068 | ~~~~~~~~~~~~~~~~~~~~~~~
  2016-04-26 14:40:22.085 | 2016-04-26 14:40:22.070 |         INFO [neutron.plugins.ml2.managers] Configured type driver names: ['local', 'flat', 'vlan', 'gre', 'vxlan', 'geneve']
  2016-04-26 14:40:22.087 | 2016-04-26 14:40:22.072 |         INFO [neutron.plugins.ml2.drivers.type_flat] Arbitrary flat physical_network names allowed
  2016-04-26 14:40:22.088 | 2016-04-26 14:40:22.074 |         INFO [neutron.plugins.ml2.drivers.type_vlan] Network VLAN ranges: {}
  2016-04-26 14:40:22.090 | 2016-04-26 14:40:22.076 |         INFO [neutron.plugins.ml2.drivers.type_local] ML2 LocalTypeDriver initialization complete
  2016-04-26 14:40:22.092 | 2016-04-26 14:40:22.077 |         INFO [neutron.plugins.ml2.managers] Loaded type driver names: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
  2016-04-26 14:40:22.094 | 2016-04-26 14:40:22.079 |         INFO [neutron.plugins.ml2.managers] Registered types: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
  2016-04-26 14:40:22.095 | 2016-04-26 14:40:22.081 |         INFO [neutron.plugins.ml2.managers] Tenant network_types: ['local']
  2016-04-26 14:40:22.097 | 2016-04-26 14:40:22.083 |         INFO [neutron.plugins.ml2.managers] Configured extension driver names: []
  2016-04-26 14:40:22.099 | 2016-04-26 14:40:22.084 |         INFO [neutron.plugins.ml2.managers] Loaded extension driver names: []
  2016-04-26 14:40:22.101 | 2016-04-26 14:40:22.086 |         INFO [neutron.plugins.ml2.managers] Registered extension drivers: []
  2016-04-26 14:40:22.102 | 2016-04-26 14:40:22.088 |         INFO [neutron.plugins.ml2.managers] Configured mechanism driver names: []
  2016-04-26 14:40:22.104 | 2016-04-26 14:40:22.090 |         INFO [neutron.plugins.ml2.managers] Loaded mechanism driver names: []
  2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.091 |         INFO [neutron.plugins.ml2.managers] Registered mechanism drivers: []
  2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.093 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'geneve'
  2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.095 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] geneve ID ranges: []
  2016-04-26 14:40:22.115 | 2016-04-26 14:40:22.097 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'flat'
  2016-04-26 14:40:22.116 | 2016-04-26 14:40:22.098 |         INFO [neutron.plugins.ml2.drivers.type_flat] ML2 FlatTypeDriver initialization complete
  2016-04-26 14:40:22.116 | 2016-04-26 14:40:22.100 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vlan'
  2016-04-26 14:40:22.117 | 2016-04-26 14:40:22.102 |         INFO [neutron.plugins.ml2.drivers.type_vlan] VlanTypeDriver initialization complete
  2016-04-26 14:40:22.118 | 2016-04-26 14:40:22.104 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'gre'
  2016-04-26 14:40:22.120 | 2016-04-26 14:40:22.105 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] gre ID ranges: []
  2016-04-26 14:40:22.122 | 2016-04-26 14:40:22.107 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'local'
  2016-04-26 14:40:22.123 | 2016-04-26 14:40:22.109 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vxlan'
  2016-04-26 14:40:22.125 | 2016-04-26 14:40:22.110 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] vxlan ID ranges: []
  2016-04-26 14:40:22.127 | 2016-04-26 14:40:22.112 |         INFO [neutron.plugins.ml2.plugin] Modular L2 Plugin initialization complete
  2016-04-26 14:40:22.129 | 2016-04-26 14:40:22.114 |         INFO [neutron.extensions.vlantransparent] Disabled vlantransparent extension.
  2016-04-26 14:40:22.130 | 2016-04-26 14:40:22.116 |         INFO [neutron.pecan_wsgi.startup] Extension Quota management support is pecan-aware. Fetching resources and controllers
  2016-04-26 14:40:22.132 | 2016-04-26 14:40:22.118 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource address_scope via URI path segment:address_scopes
  2016-04-26 14:40:22.134 | 2016-04-26 14:40:22.119 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource network via URI path segment:networks
  2016-04-26 14:40:22.135 | 2016-04-26 14:40:22.121 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource rbac_policy via URI path segment:rbac_policies
  2016-04-26 14:40:22.137 | 2016-04-26 14:40:22.122 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group via URI path segment:security_groups
  2016-04-26 14:40:22.139 | 2016-04-26 14:40:22.124 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: quotas
  2016-04-26 14:40:22.140 | 2016-04-26 14:40:22.126 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:quota. API calls may not be correctly dispatched
  2016-04-26 14:40:22.142 | 2016-04-26 14:40:22.127 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource quota via URI path segment:quotas
  2016-04-26 14:40:22.144 | 2016-04-26 14:40:22.129 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource port via URI path segment:ports
  2016-04-26 14:40:22.146 | 2016-04-26 14:40:22.131 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: routers
  2016-04-26 14:40:22.147 | 2016-04-26 14:40:22.133 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:router. API calls may not be correctly dispatched
  2016-04-26 14:40:22.149 | 2016-04-26 14:40:22.134 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource router via URI path segment:routers
  2016-04-26 14:40:22.150 | 2016-04-26 14:40:22.136 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group_rule via URI path segment:security_group_rules
  2016-04-26 14:40:22.152 | 2016-04-26 14:40:22.137 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource agent via URI path segment:agents
  2016-04-26 14:40:22.154 | 2016-04-26 14:40:22.139 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: floatingips
  2016-04-26 14:40:22.155 | 2016-04-26 14:40:22.140 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:floatingip. API calls may not be correctly dispatched
  2016-04-26 14:40:22.156 | 2016-04-26 14:40:22.142 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource floatingip via URI path segment:floatingips
  2016-04-26 14:40:22.158 | 2016-04-26 14:40:22.144 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnet via URI path segment:subnets
  2016-04-26 14:40:22.160 | 2016-04-26 14:40:22.145 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnetpool via URI path segment:subnetpools
  2016-04-26 14:40:22.162 | 2016-04-26 14:40:22.147 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource availability_zone via URI path segment:availability_zones
  2016-04-26 14:40:22.164 | 2016-04-26 14:40:22.149 |     
  2016-04-26 14:40:22.166 | 2016-04-26 14:40:22.151 | 
  2016-04-26 14:40:22.167 | 2016-04-26 14:40:22.153 | Captured traceback:
  2016-04-26 14:40:22.169 | 2016-04-26 14:40:22.155 | ~~~~~~~~~~~~~~~~~~~
  2016-04-26 14:40:22.171 | 2016-04-26 14:40:22.156 |     Traceback (most recent call last):
  2016-04-26 14:40:22.173 | 2016-04-26 14:40:22.158 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 206, in test_get
  2016-04-26 14:40:22.175 | 2016-04-26 14:40:22.160 |         self._verify_default_limits(json_body)
  2016-04-26 14:40:22.176 | 2016-04-26 14:40:22.162 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 167, in _verify_default_limits
  2016-04-26 14:40:22.178 | 2016-04-26 14:40:22.164 |         self._verify_limits(response, self.default_expected_limits)
  2016-04-26 14:40:22.180 | 2016-04-26 14:40:22.166 |       File "neutron/tests/functional/pecan_wsgi/test_controllers.py", line 164, in _verify_limits
  2016-04-26 14:40:22.182 | 2016-04-26 14:40:22.168 |         self.assertEqual(limit, response['quota'][resource])
  2016-04-26 14:40:22.184 | 2016-04-26 14:40:22.169 |     KeyError: 'subnet'
  2016-04-26 14:40:22.186 | 2016-04-26 14:40:22.171 |     
  2016-04-26 14:40:22.188 | 2016-04-26 14:40:22.173 | 
  2016-04-26 14:40:22.189 | 2016-04-26 14:40:22.175 | Captured stderr:
  2016-04-26 14:40:22.191 | 2016-04-26 14:40:22.177 | ~~~~~~~~~~~~~~~~
  2016-04-26 14:40:22.193 | 2016-04-26 14:40:22.178 |     /opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_db/sqlalchemy/enginefacade.py:1056: OsloDBDeprecationWarning: EngineFacade is deprecated; please use oslo_db.sqlalchemy.enginefacade
  2016-04-26 14:40:22.194 | 2016-04-26 14:40:22.180 |       expire_on_commit=expire_on_commit, _conf=conf)
  2016-04-26 14:40:22.196 | 2016-04-26 14:40:22.182 |     neutron/pecan_wsgi/hooks/policy_enforcement.py:166: DeprecationWarning: BaseException.message has been deprecated as of Python 2.6
  2016-04-26 14:40:22.198 | 2016-04-26 14:40:22.183 |       raise webob.exc.HTTPForbidden(e.message)
  2016-04-26 14:40:22.199 | 2016-04-26 14:40:22.185 |     
  2016-04-26 14:40:22.201 | 2016-04-26 14:40:22.187 | 
  2016-04-26 14:40:22.203 | 2016-04-26 14:40:22.189 | neutron.tests.functional.pecan_wsgi.test_hooks.TestPolicyEnforcementHook.test_after_on_get_excludes_admin_attribute
  2016-04-26 14:40:22.205 | 2016-04-26 14:40:22.191 | -------------------------------------------------------------------------------------------------------------------
  2016-04-26 14:40:22.207 | 2016-04-26 14:40:22.192 | 
  2016-04-26 14:40:22.208 | 2016-04-26 14:40:22.194 | Captured pythonlogging:
  2016-04-26 14:40:22.210 | 2016-04-26 14:40:22.196 | ~~~~~~~~~~~~~~~~~~~~~~~
  2016-04-26 14:40:22.212 | 2016-04-26 14:40:22.197 |         INFO [neutron.plugins.ml2.managers] Configured type driver names: ['local', 'flat', 'vlan', 'gre', 'vxlan', 'geneve']
  2016-04-26 14:40:22.213 | 2016-04-26 14:40:22.199 |         INFO [neutron.plugins.ml2.drivers.type_flat] Arbitrary flat physical_network names allowed
  2016-04-26 14:40:22.215 | 2016-04-26 14:40:22.201 |         INFO [neutron.plugins.ml2.drivers.type_vlan] Network VLAN ranges: {}
  2016-04-26 14:40:22.217 | 2016-04-26 14:40:22.202 |         INFO [neutron.plugins.ml2.drivers.type_local] ML2 LocalTypeDriver initialization complete
  2016-04-26 14:40:22.218 | 2016-04-26 14:40:22.204 |         INFO [neutron.plugins.ml2.managers] Loaded type driver names: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
  2016-04-26 14:40:22.220 | 2016-04-26 14:40:22.205 |         INFO [neutron.plugins.ml2.managers] Registered types: ['geneve', 'flat', 'vlan', 'gre', 'local', 'vxlan']
  2016-04-26 14:40:22.221 | 2016-04-26 14:40:22.207 |         INFO [neutron.plugins.ml2.managers] Tenant network_types: ['local']
  2016-04-26 14:40:22.223 | 2016-04-26 14:40:22.209 |         INFO [neutron.plugins.ml2.managers] Configured extension driver names: []
  2016-04-26 14:40:22.225 | 2016-04-26 14:40:22.210 |         INFO [neutron.plugins.ml2.managers] Loaded extension driver names: []
  2016-04-26 14:40:22.226 | 2016-04-26 14:40:22.212 |         INFO [neutron.plugins.ml2.managers] Registered extension drivers: []
  2016-04-26 14:40:22.228 | 2016-04-26 14:40:22.213 |         INFO [neutron.plugins.ml2.managers] Configured mechanism driver names: []
  2016-04-26 14:40:22.229 | 2016-04-26 14:40:22.215 |         INFO [neutron.plugins.ml2.managers] Loaded mechanism driver names: []
  2016-04-26 14:40:22.231 | 2016-04-26 14:40:22.217 |         INFO [neutron.plugins.ml2.managers] Registered mechanism drivers: []
  2016-04-26 14:40:22.233 | 2016-04-26 14:40:22.218 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'geneve'
  2016-04-26 14:40:22.234 | 2016-04-26 14:40:22.220 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] geneve ID ranges: []
  2016-04-26 14:40:22.236 | 2016-04-26 14:40:22.221 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'flat'
  2016-04-26 14:40:22.237 | 2016-04-26 14:40:22.223 |         INFO [neutron.plugins.ml2.drivers.type_flat] ML2 FlatTypeDriver initialization complete
  2016-04-26 14:40:22.239 | 2016-04-26 14:40:22.224 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vlan'
  2016-04-26 14:40:22.240 | 2016-04-26 14:40:22.226 |         INFO [neutron.plugins.ml2.drivers.type_vlan] VlanTypeDriver initialization complete
  2016-04-26 14:40:22.242 | 2016-04-26 14:40:22.228 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'gre'
  2016-04-26 14:40:22.244 | 2016-04-26 14:40:22.229 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] gre ID ranges: []
  2016-04-26 14:40:22.245 | 2016-04-26 14:40:22.231 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'local'
  2016-04-26 14:40:22.247 | 2016-04-26 14:40:22.232 |         INFO [neutron.plugins.ml2.managers] Initializing driver for type 'vxlan'
  2016-04-26 14:40:22.248 | 2016-04-26 14:40:22.234 |         INFO [neutron.plugins.ml2.drivers.type_tunnel] vxlan ID ranges: []
  2016-04-26 14:40:22.250 | 2016-04-26 14:40:22.235 |         INFO [neutron.plugins.ml2.plugin] Modular L2 Plugin initialization complete
  2016-04-26 14:40:22.251 | 2016-04-26 14:40:22.237 |         INFO [neutron.extensions.vlantransparent] Disabled vlantransparent extension.
  2016-04-26 14:40:22.253 | 2016-04-26 14:40:22.239 |         INFO [neutron.pecan_wsgi.startup] Extension Quota management support is pecan-aware. Fetching resources and controllers
  2016-04-26 14:40:22.255 | 2016-04-26 14:40:22.240 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource address_scope via URI path segment:address_scopes
  2016-04-26 14:40:22.256 | 2016-04-26 14:40:22.242 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource network via URI path segment:networks
  2016-04-26 14:40:22.258 | 2016-04-26 14:40:22.243 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource rbac_policy via URI path segment:rbac_policies
  2016-04-26 14:40:22.259 | 2016-04-26 14:40:22.245 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group via URI path segment:security_groups
  2016-04-26 14:40:22.261 | 2016-04-26 14:40:22.246 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: quotas
  2016-04-26 14:40:22.262 | 2016-04-26 14:40:22.248 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:quota. API calls may not be correctly dispatched
  2016-04-26 14:40:22.264 | 2016-04-26 14:40:22.250 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource quota via URI path segment:quotas
  2016-04-26 14:40:22.266 | 2016-04-26 14:40:22.251 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: routers
  2016-04-26 14:40:22.267 | 2016-04-26 14:40:22.253 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:router. API calls may not be correctly dispatched
  2016-04-26 14:40:22.269 | 2016-04-26 14:40:22.254 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource router via URI path segment:routers
  2016-04-26 14:40:22.270 | 2016-04-26 14:40:22.256 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource port via URI path segment:ports
  2016-04-26 14:40:22.272 | 2016-04-26 14:40:22.258 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource security_group_rule via URI path segment:security_group_rules
  2016-04-26 14:40:22.274 | 2016-04-26 14:40:22.259 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource agent via URI path segment:agents
  2016-04-26 14:40:22.275 | 2016-04-26 14:40:22.261 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for: floatingips
  2016-04-26 14:40:22.277 | 2016-04-26 14:40:22.263 |      WARNING [neutron.pecan_wsgi.startup] No plugin found for resource:floatingip. API calls may not be correctly dispatched
  2016-04-26 14:40:22.279 | 2016-04-26 14:40:22.264 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource floatingip via URI path segment:floatingips
  2016-04-26 14:40:22.280 | 2016-04-26 14:40:22.266 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnet via URI path segment:subnets
  2016-04-26 14:40:22.282 | 2016-04-26 14:40:22.267 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource subnetpool via URI path segment:subnetpools
  2016-04-26 14:40:22.283 | 2016-04-26 14:40:22.269 |         INFO [neutron.pecan_wsgi.startup] Added controller for resource availability_zone via URI path segment:availability_zones
  2016-04-26 14:40:22.285 | 2016-04-26 14:40:22.271 |     
  2016-04-26 14:40:22.287 | 2016-04-26 14:40:22.272 | 
  2016-04-26 14:40:22.288 | 2016-04-26 14:40:22.274 | Captured traceback:
  2016-04-26 14:40:22.290 | 2016-04-26 14:40:22.276 | ~~~~~~~~~~~~~~~~~~~
  2016-04-26 14:40:22.292 | 2016-04-26 14:40:22.277 |     Traceback (most recent call last):
  2016-04-26 14:40:22.293 | 2016-04-26 14:40:22.279 |       File "neutron/tests/functional/pecan_wsgi/test_hooks.py", line 206, in test_after_on_get_excludes_admin_attribute
  2016-04-26 14:40:22.295 | 2016-04-26 14:40:22.281 |         headers={'X-Project-Id': 'tenid'})
  2016-04-26 14:40:22.297 | 2016-04-26 14:40:22.282 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/app.py", line 327, in get
  2016-04-26 14:40:22.298 | 2016-04-26 14:40:22.284 |         expect_errors=expect_errors)
  2016-04-26 14:40:22.300 | 2016-04-26 14:40:22.285 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/app.py", line 610, in do_request
  2016-04-26 14:40:22.302 | 2016-04-26 14:40:22.287 |         res = req.get_response(app, catch_exc_info=True)
  2016-04-26 14:40:22.303 | 2016-04-26 14:40:22.289 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1295, in send
  2016-04-26 14:40:22.305 | 2016-04-26 14:40:22.290 |         application, catch_exc_info=True)
  2016-04-26 14:40:22.306 | 2016-04-26 14:40:22.292 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
  2016-04-26 14:40:22.308 | 2016-04-26 14:40:22.294 |         app_iter = application(self.environ, start_response)
  2016-04-26 14:40:22.310 | 2016-04-26 14:40:22.295 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webtest/lint.py", line 198, in lint_app
  2016-04-26 14:40:22.311 | 2016-04-26 14:40:22.297 |         iterator = application(environ, start_response_wrapper)
  2016-04-26 14:40:22.313 | 2016-04-26 14:40:22.298 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/middleware/recursive.py", line 56, in __call__
  2016-04-26 14:40:22.314 | 2016-04-26 14:40:22.300 |         return self.application(environ, start_response)
  2016-04-26 14:40:22.316 | 2016-04-26 14:40:22.302 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/middleware/errordocument.py", line 75, in __call__
  2016-04-26 14:40:22.318 | 2016-04-26 14:40:22.303 |         app_iter = self.app(environ, replacement_start_response)
  2016-04-26 14:40:22.319 | 2016-04-26 14:40:22.305 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
  2016-04-26 14:40:22.321 | 2016-04-26 14:40:22.306 |         resp = self.call_func(req, *args, **self.kwargs)
  2016-04-26 14:40:22.323 | 2016-04-26 14:40:22.308 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
  2016-04-26 14:40:22.325 | 2016-04-26 14:40:22.310 |         return self.func(req, *args, **kwargs)
  2016-04-26 14:40:22.326 | 2016-04-26 14:40:22.312 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_middleware/base.py", line 114, in __call__
  2016-04-26 14:40:22.328 | 2016-04-26 14:40:22.313 |         response = req.get_response(self.application)
  2016-04-26 14:40:22.329 | 2016-04-26 14:40:22.315 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
  2016-04-26 14:40:22.331 | 2016-04-26 14:40:22.316 |         application, catch_exc_info=False)
  2016-04-26 14:40:22.332 | 2016-04-26 14:40:22.318 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
  2016-04-26 14:40:22.334 | 2016-04-26 14:40:22.320 |         app_iter = application(self.environ, start_response)
  2016-04-26 14:40:22.336 | 2016-04-26 14:40:22.321 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
  2016-04-26 14:40:22.337 | 2016-04-26 14:40:22.323 |         resp = self.call_func(req, *args, **self.kwargs)
  2016-04-26 14:40:22.339 | 2016-04-26 14:40:22.324 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
  2016-04-26 14:40:22.340 | 2016-04-26 14:40:22.326 |         return self.func(req, *args, **kwargs)
  2016-04-26 14:40:22.342 | 2016-04-26 14:40:22.327 |       File "neutron/api/versions.py", line 42, in __call__
  2016-04-26 14:40:22.343 | 2016-04-26 14:40:22.329 |         return req.get_response(self.app)
  2016-04-26 14:40:22.345 | 2016-04-26 14:40:22.331 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
  2016-04-26 14:40:22.347 | 2016-04-26 14:40:22.332 |         application, catch_exc_info=False)
  2016-04-26 14:40:22.348 | 2016-04-26 14:40:22.334 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
  2016-04-26 14:40:22.350 | 2016-04-26 14:40:22.335 |         app_iter = application(self.environ, start_response)
  2016-04-26 14:40:22.351 | 2016-04-26 14:40:22.337 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 130, in __call__
  2016-04-26 14:40:22.353 | 2016-04-26 14:40:22.339 |         resp = self.call_func(req, *args, **self.kwargs)
  2016-04-26 14:40:22.355 | 2016-04-26 14:40:22.340 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/dec.py", line 195, in call_func
  2016-04-26 14:40:22.356 | 2016-04-26 14:40:22.342 |         return self.func(req, *args, **kwargs)
  2016-04-26 14:40:22.358 | 2016-04-26 14:40:22.344 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/oslo_middleware/request_id.py", line 37, in __call__
  2016-04-26 14:40:22.360 | 2016-04-26 14:40:22.346 |         response = req.get_response(self.application)
  2016-04-26 14:40:22.362 | 2016-04-26 14:40:22.347 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1299, in send
  2016-04-26 14:40:22.363 | 2016-04-26 14:40:22.349 |         application, catch_exc_info=False)
  2016-04-26 14:40:22.365 | 2016-04-26 14:40:22.351 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/webob/request.py", line 1263, in call_application
  2016-04-26 14:40:22.367 | 2016-04-26 14:40:22.352 |         app_iter = application(self.environ, start_response)
  2016-04-26 14:40:22.369 | 2016-04-26 14:40:22.354 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 829, in __call__
  2016-04-26 14:40:22.371 | 2016-04-26 14:40:22.356 |         return super(Pecan, self).__call__(environ, start_response)
  2016-04-26 14:40:22.373 | 2016-04-26 14:40:22.358 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 725, in __call__
  2016-04-26 14:40:22.374 | 2016-04-26 14:40:22.360 |         self.determine_hooks(state.controller), 'after', state
  2016-04-26 14:40:22.376 | 2016-04-26 14:40:22.361 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 854, in handle_hooks
  2016-04-26 14:40:22.377 | 2016-04-26 14:40:22.363 |         return super(Pecan, self).handle_hooks(hooks, *args, **kw)
  2016-04-26 14:40:22.379 | 2016-04-26 14:40:22.364 |       File "/opt/stack/new/neutron/.tox/dsvm-functional/local/lib/python2.7/site-packages/pecan/core.py", line 345, in handle_hooks
  2016-04-26 14:40:22.380 | 2016-04-26 14:40:22.366 |         result = getattr(hook, hook_type)(*args)
  2016-04-26 14:40:22.382 | 2016-04-26 14:40:22.368 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 161, in after
  2016-04-26 14:40:22.383 | 2016-04-26 14:40:22.369 |         pluralized=collection))]
  2016-04-26 14:40:22.385 | 2016-04-26 14:40:22.371 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 175, in _get_filtered_item
  2016-04-26 14:40:22.387 | 2016-04-26 14:40:22.372 |         neutron_context, resource, collection, data)
  2016-04-26 14:40:22.388 | 2016-04-26 14:40:22.374 |       File "neutron/pecan_wsgi/hooks/policy_enforcement.py", line 198, in _exclude_attributes_by_policy
  2016-04-26 14:40:22.390 | 2016-04-26 14:40:22.376 |         resource).get(attr_name)
  2016-04-26 14:40:22.393 | 2016-04-26 14:40:22.378 |     AttributeError: 'NoneType' object has no attribute 'get'
  2016-04-26 14:40:22.394 | 2016-04-26 14:40:22.380 |

To manage notifications about this bug go to:
https://bugs.launchpad.net/neutron/+bug/1575316/+subscriptions
Follow ups

[Bug 1575316] Re: Functional job failures in pecan tests
From: OpenStack Infra, 2016-04-27