[obs-tests] Build failed in Jenkins: obs_master_testsuite_api #1429
See <http://ci.opensuse.org/job/obs_master_testsuite_api/1429/changes> Changes: [Stephan Kulow] [api] remove tons of code from the status/bsrequest route ------------------------------------------ [...truncated 140876 lines...] [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000009164cd0> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"project_meta", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] [1m[36mProjectUserRoleRelationship Load (0.3ms)[0m [1mSELECT ur.db_project_id, ur.bs_user_id from flags f, project_user_role_relationships ur where f.flag = 'access' and ur.db_project_id = f.db_project_id[0m [[0;37mDEBUG[0m|#21162] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000009164ca8> took 152ms [[32mINFO [0m|#21162] Completed 200 OK in 160ms (Views: 0.4ms | ActiveRecord: 1.2ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started GET "/source/kde4" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#index_project as XML [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000008ea3640> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.5ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND (packages.db_project_id not in (0))[0m [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"response"} [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000008ea3668> took 0ms [[32mINFO [0m|#21162] Completed 200 OK in 10ms (Views: 0.4ms | ActiveRecord: 1.4ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x000000056f3060> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position[0m [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x000000056f2e30> took 2ms [[32mINFO [0m|#21162] Completed 200 OK in 17ms (Views: 0.4ms | ActiveRecord: 1.7ms | Backend: 0.0ms | XML: 0.3ms) [[32mINFO [0m|#21162] Started PUT "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"<package name"=>"\"kdebase\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n</package>\n", "project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000006eba4f0> [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mCACHE (0.0ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position [[0;37mDEBUG[0m|#21162] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#21162] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2[0m [[0;37mDEBUG[0m|#21162] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#21162] xml_disabled? X({"name"=>"kdebase", "project"=>"kde4", "title"=>"blub", "description"=>"blub"}) [[0;37mDEBUG[0m|#21162] [1m[35m (0.1ms)[0m SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012575 WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27559]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.010166806 [[0;37mDEBUG[0m|#21162] [1m[35mPackageGroupRoleRelationship Load (0.5ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.4ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.3ms)[0m UPDATE `packages` SET `activity_index` = 10.000002178715334 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35m (0.3ms)[0m UPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [1m[36mPackageUserRoleRelationship Load (0.4ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27560]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.009696286 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.4ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.4ms)[0m UPDATE `packages` SET `activity_index` = 10.000003921737273 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35m (0.3ms)[0m UPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [1m[36mPackageUserRoleRelationship Load (0.5ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27561]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.010456322 [[0;37mDEBUG[0m|#21162] [1m[36m (0.0ms)[0m [1mRELEASE SAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000006eba388> took 1ms [[32mINFO [0m|#21162] Completed 200 OK in 91ms (Views: 1.5ms | ActiveRecord: 7.6ms | Backend: 30.3ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000007eb0f08> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.5ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.4ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.3ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000007eb0ee0> took 2ms [[32mINFO [0m|#21162] Completed 200 OK in 14ms (Views: 0.4ms | ActiveRecord: 1.6ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000007fe7818> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`id` = 1234 AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000007fe77f0> took 2ms [[32mINFO [0m|#21162] Completed 200 OK in 21ms (Views: 0.4ms | ActiveRecord: 2.4ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started PUT "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 13:52:15 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"<package name"=>"\"kdelibs\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n <devel project=\"home:coolo:test\" package=\"kdelibs_DEVEL_package\"/>\n <person userid=\"fredlibs\" role=\"maintainer\"/>\n <person userid=\"adrian\" role=\"reviewer\"/>\n <group groupid=\"test_group\" role=\"maintainer\"/>\n</package>\n", "project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x000000084669c0> [[0;37mDEBUG[0m|#21162] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mCACHE (0.0ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mFlag Load (0.3ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position[0m [[0;37mDEBUG[0m|#21162] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#21162] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 [[0;37mDEBUG[0m|#21162] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#21162] xml_disabled? X({"name"=>"kdelibs", "project"=>"kde4", "title"=>"blub", "description"=>"blub", "devel"=>X({"project"=>"home:coolo:test", "package"=>"kdelibs_DEVEL_package"}), "person"=>[X({"userid"=>"fredlibs", "role"=>"maintainer"}), X({"userid"=>"adrian", "role"=>"reviewer"})], "group"=>X({"groupid"=>"test_group", "role"=>"maintainer"})}) [[0;37mDEBUG[0m|#21162] [1m[36m (0.1ms)[0m [1mSAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'home:coolo:test' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 601 AND `packages`.`name` = 'kdelibs_DEVEL_package' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 4 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.2ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 42 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mRole Load (0.1ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 6 LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012575 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27562]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.012032704 [[0;37mDEBUG[0m|#21162] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`login` = 'fredlibs' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE `users`.`login` = 'adrian' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackageGroupRoleRelationship Load (0.3ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`id` = 99 LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mRole Load (0.2ms)[0m SELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mGroup Load (0.3ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`title` = 'test_group' LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000003302400863 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27563]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.013219988 [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.4ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364219535)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mSQL (0.1ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000005212288212 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36m (0.3ms)[0m [1mUPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 13:52:15' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [1m[35mPackageUserRoleRelationship Load (0.4ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#21162] [1m[36mPackageGroupRoleRelationship Load (0.0ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#21162] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#21162] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21167] 2013-03-25 13:52:15 [27564]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#21162] request took 0.01067919 [[0;37mDEBUG[0m|#21162] [1m[35m (0.2ms)[0m RELEASE SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x000000084668f8> took 1ms [[32mINFO [0m|#21162] Completed 200 OK in 111ms (Views: 1.4ms | ActiveRecord: 9.6ms | Backend: 35.9ms | XML: 0.0ms) [[32mINFO [0m|#21162] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 13:52:16 +0000 [[32mINFO [0m|#21162] Processing by SourceController#package_meta as XML [[32mINFO [0m|#21162] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#21162] Validate XML request: #<ActionDispatch::Request:0x00000008c821b8> [[0;37mDEBUG[0m|#21162] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#21162] [1m[36mUser Load (0.4ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#21162] USER found: king [[0;37mDEBUG[0m|#21162] User king initialised [[0;37mDEBUG[0m|#21162] get_by_project_and_name {} [[0;37mDEBUG[0m|#21162] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#21162] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#21162] Validate XML response: #<ActionDispatch::Response:0x00000008c82168> took 2ms [[32mINFO [0m|#21162] Completed 200 OK in 13ms (Views: 0.4ms | ActiveRecord: 1.3ms | Backend: 0.0ms | XML: 0.0ms) [[0;37mDEBUG[0m|#21162] [1m[35m (6.0ms)[0m ROLLBACK [[0;37mDEBUG[0m|#21162] kill 21167 + echo + cleanup + echo 'Killing backend processes' Killing backend processes + fuser -v <http://ci.opensuse.org/job/obs_master_testsuite_api/ws/> + egrep 'perl|ruby' + echo 'Remove log/tmp files to save disc space' Remove log/tmp files to save disc space + rm -rf src/api/log/backend_access.log src/api/log/test.log src/api/tmp/cache src/api/tmp/pids src/api/tmp/sessions src/api/tmp/sockets 'src/webui/log/*' src/webui/tmp/cache src/webui/tmp/pids src/webui/tmp/sessions src/webui/tmp/sockets + exit 1 Build step 'Execute shell' marked build as failure [locks-and-latches] Releasing all the locks [locks-and-latches] All the locks released Recording test results -- To unsubscribe, e-mail: obs-tests+unsubscribe@opensuse.org To contact the owner, e-mail: obs-tests+owner@opensuse.org
See <http://ci.opensuse.org/job/obs_master_testsuite_api/1430/changes> Changes: [ro] [backend] support for dumpstate and dropbadhosts in bs_dispatch ------------------------------------------ [...truncated 140884 lines...] [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000008c6f158> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"project_meta", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] [1m[36mProjectUserRoleRelationship Load (0.3ms)[0m [1mSELECT ur.db_project_id, ur.bs_user_id from flags f, project_user_role_relationships ur where f.flag = 'access' and ur.db_project_id = f.db_project_id[0m [[0;37mDEBUG[0m|#29718] [1m[35mRole Load (0.2ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000008c6f130> took 2ms [[32mINFO [0m|#29718] Completed 200 OK in 8ms (Views: 0.4ms | ActiveRecord: 1.0ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started GET "/source/kde4" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#index_project as XML [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000007c69628> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.2ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND (packages.db_project_id not in (0))[0m [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"response"} [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000007c69600> took 0ms [[32mINFO [0m|#29718] Completed 200 OK in 7ms (Views: 0.3ms | ActiveRecord: 0.8ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000008c98418> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.2ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position[0m [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000008c983f0> took 1ms [[32mINFO [0m|#29718] Completed 200 OK in 15ms (Views: 0.3ms | ActiveRecord: 1.6ms | Backend: 0.0ms | XML: 0.2ms) [[32mINFO [0m|#29718] Started PUT "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"<package name"=>"\"kdebase\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n</package>\n", "project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000008d84408> [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (1.1ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.4ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mCACHE (0.0ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position [[0;37mDEBUG[0m|#29718] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#29718] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2[0m [[0;37mDEBUG[0m|#29718] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#29718] xml_disabled? X({"name"=>"kdebase", "project"=>"kde4", "title"=>"blub", "description"=>"blub"}) [[0;37mDEBUG[0m|#29718] [1m[35m (0.1ms)[0m SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012568 WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36m (0.1ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3894]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.016562534 [[0;37mDEBUG[0m|#29718] [1m[35mPackageGroupRoleRelationship Load (0.3ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `activity_index` = 10.000002712066527 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.1ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35m (0.1ms)[0m UPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3895]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.011236591 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.4ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `activity_index` = 10.000004835951108 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35m (0.2ms)[0m UPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3896]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.011135208 [[0;37mDEBUG[0m|#29718] [1m[36m (0.2ms)[0m [1mRELEASE SAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000008d843b8> took 1ms [[32mINFO [0m|#29718] Completed 200 OK in 200ms (Views: 0.8ms | ActiveRecord: 7.4ms | Backend: 38.9ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000007778290> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x000000077781c8> took 2ms [[32mINFO [0m|#29718] Completed 200 OK in 12ms (Views: 0.3ms | ActiveRecord: 1.1ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000007ae4078> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`id` = 1234 AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000007ae3ee8> took 2ms [[32mINFO [0m|#29718] Completed 200 OK in 18ms (Views: 0.3ms | ActiveRecord: 2.0ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started PUT "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"<package name"=>"\"kdelibs\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n <devel project=\"home:coolo:test\" package=\"kdelibs_DEVEL_package\"/>\n <person userid=\"fredlibs\" role=\"maintainer\"/>\n <person userid=\"adrian\" role=\"reviewer\"/>\n <group groupid=\"test_group\" role=\"maintainer\"/>\n</package>\n", "project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000007f41698> [[0;37mDEBUG[0m|#29718] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] [1m[35mRole Load (0.2ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mCACHE (0.0ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mFlag Load (0.3ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position[0m [[0;37mDEBUG[0m|#29718] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#29718] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 [[0;37mDEBUG[0m|#29718] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#29718] xml_disabled? X({"name"=>"kdelibs", "project"=>"kde4", "title"=>"blub", "description"=>"blub", "devel"=>X({"project"=>"home:coolo:test", "package"=>"kdelibs_DEVEL_package"}), "person"=>[X({"userid"=>"fredlibs", "role"=>"maintainer"}), X({"userid"=>"adrian", "role"=>"reviewer"})], "group"=>X({"groupid"=>"test_group", "role"=>"maintainer"})}) [[0;37mDEBUG[0m|#29718] [1m[36m (0.1ms)[0m [1mSAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'home:coolo:test' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 601 AND `packages`.`name` = 'kdelibs_DEVEL_package' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 4 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.1ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 42 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mRole Load (0.1ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 6 LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012568 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3897]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.012213373 [[0;37mDEBUG[0m|#29718] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`login` = 'fredlibs' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE `users`.`login` = 'adrian' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36mGroup Load (0.1ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`id` = 99 LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mRole Load (0.1ms)[0m SELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`title` = 'test_group' LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000002888534908 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.1ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3898]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.00910902 [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.4ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364224944)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000004653605046 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mSQL (0.1ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36m (0.1ms)[0m [1mUPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:22:24' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#29718] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#29718] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#29718] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29723] 2013-03-25 15:22:24 [3899]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#29718] request took 0.015287518 [[0;37mDEBUG[0m|#29718] [1m[35m (0.3ms)[0m RELEASE SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000007f41670> took 0ms [[32mINFO [0m|#29718] Completed 200 OK in 99ms (Views: 0.9ms | ActiveRecord: 8.4ms | Backend: 36.6ms | XML: 0.0ms) [[32mINFO [0m|#29718] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:22:24 +0000 [[32mINFO [0m|#29718] Processing by SourceController#package_meta as XML [[32mINFO [0m|#29718] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#29718] Validate XML request: #<ActionDispatch::Request:0x00000008867c90> [[0;37mDEBUG[0m|#29718] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#29718] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#29718] USER found: king [[0;37mDEBUG[0m|#29718] User king initialised [[0;37mDEBUG[0m|#29718] get_by_project_and_name {} [[0;37mDEBUG[0m|#29718] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#29718] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#29718] Validate XML response: #<ActionDispatch::Response:0x00000008867c40> took 1ms [[32mINFO [0m|#29718] Completed 200 OK in 11ms (Views: 0.3ms | ActiveRecord: 1.2ms | Backend: 0.0ms | XML: 0.0ms) [[0;37mDEBUG[0m|#29718] [1m[35m (1326.2ms)[0m ROLLBACK [[0;37mDEBUG[0m|#29718] kill 29723 + echo + cleanup + echo 'Killing backend processes' Killing backend processes + egrep 'perl|ruby' + fuser -v <http://ci.opensuse.org/job/obs_master_testsuite_api/ws/> + echo 'Remove log/tmp files to save disc space' Remove log/tmp files to save disc space + rm -rf src/api/log/backend_access.log src/api/log/test.log src/api/tmp/backend_config src/api/tmp/backend_data src/api/tmp/cache src/api/tmp/pids src/api/tmp/scheduler.done src/api/tmp/sessions src/api/tmp/sockets 'src/webui/log/*' src/webui/tmp/cache src/webui/tmp/pids src/webui/tmp/sessions src/webui/tmp/sockets + exit 1 Build step 'Execute shell' marked build as failure [locks-and-latches] Releasing all the locks [locks-and-latches] All the locks released Recording test results -- To unsubscribe, e-mail: obs-tests+unsubscribe@opensuse.org To contact the owner, e-mail: obs-tests+owner@opensuse.org
See <http://ci.opensuse.org/job/obs_master_testsuite_api/1431/changes> Changes: [ro] [backend] allow to disable syncing of kiwi trees in BSConfig ------------------------------------------ [...truncated 140894 lines...] [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000007f437b8> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"project_meta", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] [1m[36mProjectUserRoleRelationship Load (0.3ms)[0m [1mSELECT ur.db_project_id, ur.bs_user_id from flags f, project_user_role_relationships ur where f.flag = 'access' and ur.db_project_id = f.db_project_id[0m [[0;37mDEBUG[0m|# 5375] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000007f43768> took 2ms [[32mINFO [0m|# 5375] Completed 200 OK in 9ms (Views: 0.5ms | ActiveRecord: 1.1ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started GET "/source/kde4" for 127.0.0.1 at 2013-03-25 15:28:35 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#index_project as XML [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000007fe90a0> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND (packages.db_project_id not in (0))[0m [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"response"} [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000007fe9078> took 0ms [[32mINFO [0m|# 5375] Completed 200 OK in 8ms (Views: 0.4ms | ActiveRecord: 1.0ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:28:35 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x000000080a1150> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position[0m [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x000000080a0fe8> took 2ms [[32mINFO [0m|# 5375] Completed 200 OK in 16ms (Views: 0.4ms | ActiveRecord: 1.8ms | Backend: 0.0ms | XML: 0.3ms) [[32mINFO [0m|# 5375] Started PUT "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:28:35 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"<package name"=>"\"kdebase\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n</package>\n", "project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000008514458> [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.3ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.3ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mCACHE (0.0ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mFlag Load (0.4ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position [[0;37mDEBUG[0m|# 5375] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|# 5375] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2[0m [[0;37mDEBUG[0m|# 5375] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|# 5375] xml_disabled? X({"name"=>"kdebase", "project"=>"kde4", "title"=>"blub", "description"=>"blub"}) [[0;37mDEBUG[0m|# 5375] [1m[35m (0.1ms)[0m SAVEPOINT active_record_1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012568 WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36m (0.1ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[35mPackageUserRoleRelationship Load (0.2ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11771]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.010187879 [[0;37mDEBUG[0m|# 5375] [1m[35mPackageGroupRoleRelationship Load (0.5ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.4ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.3ms)[0m UPDATE `packages` SET `activity_index` = 10.000002076145675 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35m (0.3ms)[0m UPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[36mPackageUserRoleRelationship Load (0.4ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackageGroupRoleRelationship Load (0.3ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11772]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.011581562 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.6ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.3ms)[0m UPDATE `packages` SET `activity_index` = 10.000004116556159 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35m (0.2ms)[0m UPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[36mPackageUserRoleRelationship Load (0.4ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11773]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.014381359 [[0;37mDEBUG[0m|# 5375] [1m[36m (0.2ms)[0m [1mRELEASE SAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000008514408> took 0ms [[32mINFO [0m|# 5375] Completed 200 OK in 91ms (Views: 1.0ms | ActiveRecord: 8.4ms | Backend: 36.2ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:28:36 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000008b8d1b8> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000008b8d168> took 1ms [[32mINFO [0m|# 5375] Completed 200 OK in 12ms (Views: 0.4ms | ActiveRecord: 1.3ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:28:36 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000008ad4c30> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[35mRole Load (0.2ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`id` = 1234 AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mFlag Load (0.3ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000008ad4c08> took 1ms [[32mINFO [0m|# 5375] Completed 200 OK in 18ms (Views: 0.4ms | ActiveRecord: 2.0ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started PUT "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:28:36 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"<package name"=>"\"kdelibs\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n <devel project=\"home:coolo:test\" package=\"kdelibs_DEVEL_package\"/>\n <person userid=\"fredlibs\" role=\"maintainer\"/>\n <person userid=\"adrian\" role=\"reviewer\"/>\n <group groupid=\"test_group\" role=\"maintainer\"/>\n</package>\n", "project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x00000008c4e9a8> [[0;37mDEBUG[0m|# 5375] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mCACHE (0.0ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mFlag Load (5.1ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mFlag Load (2.7ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mFlag Load (0.3ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position[0m [[0;37mDEBUG[0m|# 5375] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|# 5375] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 [[0;37mDEBUG[0m|# 5375] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|# 5375] xml_disabled? X({"name"=>"kdelibs", "project"=>"kde4", "title"=>"blub", "description"=>"blub", "devel"=>X({"project"=>"home:coolo:test", "package"=>"kdelibs_DEVEL_package"}), "person"=>[X({"userid"=>"fredlibs", "role"=>"maintainer"}), X({"userid"=>"adrian", "role"=>"reviewer"})], "group"=>X({"groupid"=>"test_group", "role"=>"maintainer"})}) [[0;37mDEBUG[0m|# 5375] [1m[36m (0.1ms)[0m [1mSAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'home:coolo:test' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 601 AND `packages`.`name` = 'kdelibs_DEVEL_package' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 4 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.2ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 42 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mRole Load (0.1ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 6 LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.3ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012568 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[35mPackageUserRoleRelationship Load (0.4ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageGroupRoleRelationship Load (0.4ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11774]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.014807302 [[0;37mDEBUG[0m|# 5375] [1m[35mUser Load (0.6ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`login` = 'fredlibs' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE `users`.`login` = 'adrian' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`id` = 99 LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mRole Load (0.2ms)[0m SELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`title` = 'test_group' LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.3ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000003442361399 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.1ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36m (0.1ms)[0m [1mUPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11775]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.011971801 [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.5ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364225316)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000006025505286 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:28:36' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [1m[35mPackageUserRoleRelationship Load (0.6ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|# 5375] [1m[36mPackageGroupRoleRelationship Load (0.3ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|# 5375] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|# 5375] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5380] 2013-03-25 15:28:36 [11776]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|# 5375] request took 0.010849889 [[0;37mDEBUG[0m|# 5375] [1m[35m (0.2ms)[0m RELEASE SAVEPOINT active_record_1 [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x00000008c4e980> took 1ms [[32mINFO [0m|# 5375] Completed 200 OK in 267ms (Views: 1.2ms | ActiveRecord: 17.7ms | Backend: 37.6ms | XML: 0.0ms) [[32mINFO [0m|# 5375] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:28:36 +0000 [[32mINFO [0m|# 5375] Processing by SourceController#package_meta as XML [[32mINFO [0m|# 5375] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|# 5375] Validate XML request: #<ActionDispatch::Request:0x000000076e4680> [[0;37mDEBUG[0m|# 5375] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|# 5375] [1m[36mUser Load (0.4ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] USER found: king [[0;37mDEBUG[0m|# 5375] User king initialised [[0;37mDEBUG[0m|# 5375] get_by_project_and_name {} [[0;37mDEBUG[0m|# 5375] [1m[35mRole Load (0.5ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|# 5375] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|# 5375] Validate XML response: #<ActionDispatch::Response:0x000000076e45e0> took 2ms [[32mINFO [0m|# 5375] Completed 200 OK in 15ms (Views: 0.5ms | ActiveRecord: 1.6ms | Backend: 0.0ms | XML: 0.0ms) [[0;37mDEBUG[0m|# 5375] [1m[35m (5.4ms)[0m ROLLBACK [[0;37mDEBUG[0m|# 5375] kill 5380 + echo + cleanup + echo 'Killing backend processes' Killing backend processes + egrep 'perl|ruby' + fuser -v <http://ci.opensuse.org/job/obs_master_testsuite_api/ws/> + echo 'Remove log/tmp files to save disc space' Remove log/tmp files to save disc space + rm -rf src/api/log/backend_access.log src/api/log/test.log src/api/tmp/cache src/api/tmp/pids src/api/tmp/sessions src/api/tmp/sockets 'src/webui/log/*' src/webui/tmp/cache src/webui/tmp/pids src/webui/tmp/sessions src/webui/tmp/sockets + exit 1 Build step 'Execute shell' marked build as failure [locks-and-latches] Releasing all the locks [locks-and-latches] All the locks released Recording test results -- To unsubscribe, e-mail: obs-tests+unsubscribe@opensuse.org To contact the owner, e-mail: obs-tests+owner@opensuse.org
See <http://ci.opensuse.org/job/obs_master_testsuite_api/1432/changes> Changes: [mls] [backend] only calculate worker/buildcode state every 20 seconds ------------------------------------------ [...truncated 140884 lines...] [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000008240a10> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"project_meta", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.5ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] [1m[36mProjectUserRoleRelationship Load (0.3ms)[0m [1mSELECT ur.db_project_id, ur.bs_user_id from flags f, project_user_role_relationships ur where f.flag = 'access' and ur.db_project_id = f.db_project_id[0m [[0;37mDEBUG[0m|#13456] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.3ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x00000008240920> took 3ms [[32mINFO [0m|#13456] Completed 200 OK in 13ms (Views: 0.6ms | ActiveRecord: 1.4ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started GET "/source/kde4" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#index_project as XML [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x0000000851c8b0> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.4ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND (packages.db_project_id not in (0))[0m [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"index_project", "project"=>"kde4", "method"=>"GET", "type"=>"response"} [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x0000000851c888> took 0ms [[32mINFO [0m|#13456] Completed 200 OK in 9ms (Views: 0.4ms | ActiveRecord: 1.2ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x000000086fdb70> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.3ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.3ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.3ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [1m[36mPackageUserRoleRelationship Load (0.3ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36mFlag Load (0.3ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position[0m [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x000000086fdb20> took 2ms [[32mINFO [0m|#13456] Completed 200 OK in 17ms (Views: 0.4ms | ActiveRecord: 2.1ms | Backend: 0.0ms | XML: 0.3ms) [[32mINFO [0m|#13456] Started PUT "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"<package name"=>"\"kdebase\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n</package>\n", "project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000008849448> [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.4ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.3ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.3ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mCACHE (0.0ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mCACHE (0.0ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mFlag Load (0.7ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mFlag Load (0.4ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mFlag Load (0.3ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 2 ORDER BY position [[0;37mDEBUG[0m|#13456] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#13456] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2[0m [[0;37mDEBUG[0m|#13456] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#13456] xml_disabled? X({"name"=>"kdebase", "project"=>"kde4", "title"=>"blub", "description"=>"blub"}) [[0;37mDEBUG[0m|#13456] [1m[35m (0.1ms)[0m SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageUserRoleRelationship Load (0.2ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.3ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012566 WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [1m[35mPackageUserRoleRelationship Load (0.4ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19896]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.009102154 [[0;37mDEBUG[0m|#13456] [1m[35mPackageGroupRoleRelationship Load (0.4ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.3ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.3ms)[0m UPDATE `packages` SET `activity_index` = 10.000002013533203 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.2ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35m (0.2ms)[0m UPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [1m[36mPackageUserRoleRelationship Load (0.5ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackageGroupRoleRelationship Load (0.4ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19897]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.012697018 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.6ms)[0m [1mSELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 2 LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.4ms)[0m UPDATE `packages` SET `activity_index` = 10.000004264326007 WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35m (0.2ms)[0m UPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 2 [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [1m[36mPackageUserRoleRelationship Load (0.5ms)[0m [1mSELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 2[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackageGroupRoleRelationship Load (0.4ms)[0m SELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 2 [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdebase ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19898]: PUT /source/kde4/kdebase/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.011369703 [[0;37mDEBUG[0m|#13456] [1m[36m (0.2ms)[0m [1mRELEASE SAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x000000088493f8> took 1ms [[32mINFO [0m|#13456] Completed 200 OK in 95ms (Views: 1.0ms | ActiveRecord: 9.9ms | Backend: 33.2ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started GET "/source/kde4/kdebase/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4", "package"=>"kdebase"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000008c94d68> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdebase", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.4ms)[0m SELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1 [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.4ms)[0m [1mSELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.2ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdebase' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.2ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x00000008c94d40> took 1ms [[32mINFO [0m|#13456] Completed 200 OK in 13ms (Views: 0.5ms | ActiveRecord: 1.4ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000008e358e8> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[36mUser Load (0.3ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[35mRole Load (0.3ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`id` = 1234 AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackageUserRoleRelationship Load (0.3ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mFlag Load (0.2ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x00000008e358c0> took 157ms [[32mINFO [0m|#13456] Completed 200 OK in 175ms (Views: 0.4ms | ActiveRecord: 2.3ms | Backend: 0.0ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started PUT "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"<package name"=>"\"kdelibs\" project=\"kde4\">\n <title>blub</title>\n <description>blub</description>\n <devel project=\"home:coolo:test\" package=\"kdelibs_DEVEL_package\"/>\n <person userid=\"fredlibs\" role=\"maintainer\"/>\n <person userid=\"adrian\" role=\"reviewer\"/>\n <group groupid=\"test_group\" role=\"maintainer\"/>\n</package>\n", "project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000008b34158> [[0;37mDEBUG[0m|#13456] [1m[36mUser Load (0.4ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] [1m[35mRole Load (0.4ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.3ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mCACHE (0.0ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mCACHE (0.0ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mFlag Load (0.6ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' ORDER BY position LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mFlag Load (0.3ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 AND `flags`.`flag` = 'lock' AND `flags`.`status` = 'enable' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mFlag Load (0.2ms)[0m [1mSELECT `flags`.* FROM `flags` WHERE `flags`.`db_package_id` = 1 ORDER BY position[0m [[0;37mDEBUG[0m|#13456] flagcheck: package has default state, checking project [[0;37mDEBUG[0m|#13456] [1m[35mFlag Load (0.3ms)[0m SELECT `flags`.* FROM `flags` WHERE `flags`.`db_project_id` = 2 [[0;37mDEBUG[0m|#13456] disabled_for sourceaccess repo: arch: state:enable [[0;37mDEBUG[0m|#13456] xml_disabled? X({"name"=>"kdelibs", "project"=>"kde4", "title"=>"blub", "description"=>"blub", "devel"=>X({"project"=>"home:coolo:test", "package"=>"kdelibs_DEVEL_package"}), "person"=>[X({"userid"=>"fredlibs", "role"=>"maintainer"}), X({"userid"=>"adrian", "role"=>"reviewer"})], "group"=>X({"groupid"=>"test_group", "role"=>"maintainer"})}) [[0;37mDEBUG[0m|#13456] [1m[36m (0.1ms)[0m [1mSAVEPOINT active_record_1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.3ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'home:coolo:test' AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackage Load (0.4ms)[0m [1mSELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 601 AND `packages`.`name` = 'kdelibs_DEVEL_package' AND (packages.db_project_id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mProject Load (0.3ms)[0m SELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 601 AND (projects.id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageUserRoleRelationship Load (0.3ms)[0m [1mSELECT `package_user_role_relationships`.* FROM `package_user_role_relationships` WHERE `package_user_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 4 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.2ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.2ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`id` = 42 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mRole Load (0.2ms)[0m [1mSELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 6 LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.3ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000000000012566 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 1, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [1m[35mPackageUserRoleRelationship Load (0.4ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageGroupRoleRelationship Load (0.3ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19899]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.013126448 [[0;37mDEBUG[0m|#13456] [1m[35mUser Load (0.6ms)[0m SELECT `users`.* FROM `users` WHERE `users`.`login` = 'fredlibs' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mUser Load (0.2ms)[0m [1mSELECT `users`.* FROM `users` WHERE `users`.`login` = 'adrian' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackageGroupRoleRelationship Load (0.2ms)[0m SELECT `package_group_role_relationships`.* FROM `package_group_role_relationships` WHERE `package_group_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`id` = 99 LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mRole Load (0.2ms)[0m SELECT `roles`.* FROM `roles` WHERE `roles`.`id` = 3 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mGroup Load (0.2ms)[0m [1mSELECT `groups`.* FROM `groups` WHERE `groups`.`title` = 'test_group' LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.2ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000003488058294 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 2, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [1m[35mPackageUserRoleRelationship Load (0.4ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageGroupRoleRelationship Load (0.2ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19900]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.012639897 [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.6ms)[0m SELECT packages.*, ( packages.activity_index * POWER( 2.3276, (UNIX_TIMESTAMP(packages.updated_at) - 1364227048)/10000000 ) ) as activity_value FROM `packages` WHERE id = 1 LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mSQL (0.3ms)[0m [1mUPDATE `packages` SET `activity_index` = 10.000006188507433 WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mSQL (0.2ms)[0m UPDATE `packages` SET `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36m (0.2ms)[0m [1mUPDATE `packages` SET `update_counter` = 3, `updated_at` = '2013-03-25 15:57:28' WHERE `packages`.`id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [1m[35mPackageUserRoleRelationship Load (0.5ms)[0m SELECT users.login as login, roles.title AS role_name FROM `package_user_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_user_role_relationships`.`role_id` INNER JOIN `users` ON `users`.`id` = `package_user_role_relationships`.`bs_user_id` WHERE `package_user_role_relationships`.`db_package_id` = 1 [[0;37mDEBUG[0m|#13456] [1m[36mPackageGroupRoleRelationship Load (0.4ms)[0m [1mSELECT groups.title as title, roles.title as role_name FROM `package_group_role_relationships` INNER JOIN `roles` ON `roles`.`id` = `package_group_role_relationships`.`role_id` INNER JOIN `groups` ON `groups`.`id` = `package_group_role_relationships`.`bs_group_id` WHERE `package_group_role_relationships`.`db_package_id` = 1[0m [[0;37mDEBUG[0m|#13456] ----------------- end rendering package kdelibs ------------------------ [[0;37mDEBUG[0m|#13456] [backend] PUT: /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13461] 2013-03-25 15:57:28 [19901]: PUT /source/kde4/kdelibs/_meta?user=king [[0;37mDEBUG[0m|#13456] request took 0.015524279 [[0;37mDEBUG[0m|#13456] [1m[35m (0.3ms)[0m RELEASE SAVEPOINT active_record_1 [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x00000008b344a0> took 1ms [[32mINFO [0m|#13456] Completed 200 OK in 124ms (Views: 1.1ms | ActiveRecord: 12.2ms | Backend: 41.3ms | XML: 0.0ms) [[32mINFO [0m|#13456] Started GET "/source/kde4/kdelibs/_meta" for 127.0.0.1 at 2013-03-25 15:57:28 +0000 [[32mINFO [0m|#13456] Processing by SourceController#package_meta as XML [[32mINFO [0m|#13456] Parameters: {"project"=>"kde4", "package"=>"kdelibs"} [[0;37mDEBUG[0m|#13456] Validate XML request: #<ActionDispatch::Request:0x00000007b888a8> [[0;37mDEBUG[0m|#13456] no schema found, skipping validation for {"format"=>"xml", "controller"=>"source", "action"=>"package_meta", "project"=>"kde4", "package"=>"kdelibs", "method"=>"GET", "type"=>"request"} [[0;37mDEBUG[0m|#13456] [1m[36mUser Load (0.4ms)[0m [1mSELECT `users`.* FROM `users` WHERE (login = 'king') LIMIT 1[0m [[0;37mDEBUG[0m|#13456] USER found: king [[0;37mDEBUG[0m|#13456] User king initialised [[0;37mDEBUG[0m|#13456] get_by_project_and_name {} [[0;37mDEBUG[0m|#13456] [1m[35mRole Load (0.4ms)[0m SELECT DISTINCT roles.id FROM `roles` INNER JOIN `roles_users` ON `roles`.`id` = `roles_users`.`role_id` WHERE `roles_users`.`user_id` = 2 AND `roles`.`title` = 'Admin' LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`name` = 'kde4' AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] [1m[35mPackage Load (0.2ms)[0m SELECT `packages`.* FROM `packages` WHERE `packages`.`db_project_id` = 2 AND `packages`.`name` = 'kdelibs' AND (packages.db_project_id not in (0)) LIMIT 1 [[0;37mDEBUG[0m|#13456] [1m[36mProject Load (0.2ms)[0m [1mSELECT `projects`.* FROM `projects` WHERE `projects`.`id` = 2 AND (projects.id not in (0)) LIMIT 1[0m [[0;37mDEBUG[0m|#13456] Validate XML response: #<ActionDispatch::Response:0x00000007b88808> took 2ms [[32mINFO [0m|#13456] Completed 200 OK in 13ms (Views: 0.5ms | ActiveRecord: 1.4ms | Backend: 0.0ms | XML: 0.0ms) [[0;37mDEBUG[0m|#13456] [1m[35m (5.3ms)[0m ROLLBACK [[0;37mDEBUG[0m|#13456] kill 13461 + echo + cleanup + echo 'Killing backend processes' Killing backend processes + fuser -v <http://ci.opensuse.org/job/obs_master_testsuite_api/ws/> + egrep 'perl|ruby' + echo 'Remove log/tmp files to save disc space' Remove log/tmp files to save disc space + rm -rf src/api/log/backend_access.log src/api/log/test.log src/api/tmp/cache src/api/tmp/pids src/api/tmp/sessions src/api/tmp/sockets 'src/webui/log/*' src/webui/tmp/cache src/webui/tmp/pids src/webui/tmp/sessions src/webui/tmp/sockets + exit 1 Build step 'Execute shell' marked build as failure [locks-and-latches] Releasing all the locks [locks-and-latches] All the locks released Recording test results -- To unsubscribe, e-mail: obs-tests+unsubscribe@opensuse.org To contact the owner, e-mail: obs-tests+owner@opensuse.org
See <http://ci.opensuse.org/job/obs_master_testsuite_api/1433/changes> -- To unsubscribe, e-mail: obs-tests+unsubscribe@opensuse.org To contact the owner, e-mail: obs-tests+owner@opensuse.org
participants (1)
-
admin＠opensuse.org