Connecting to database specified by database.yml  (0.5ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction Processing by MainController#index as HTML Completed 200 OK in 36ms (Views: 35.4ms | ActiveRecord: 0.0ms)  (0.1ms) rollback transaction Connecting to database specified by database.yml  (0.6ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.1ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction Processing by MainController#index as HTML Completed 200 OK in 96ms (Views: 95.1ms | ActiveRecord: 0.0ms)  (0.1ms) rollback transaction Connecting to database specified by database.yml  (0.5ms) begin transaction Fixture Delete (0.6ms) DELETE FROM "contacts" Fixture Insert (0.7ms) INSERT INTO "contacts" ("name", "details", "phone", "email", "url", "created_at", "updated_at", "id", "group_id") VALUES ('Kevin', 'A Ruby on Rails and Cocoa developer...', '(555) 555-5555', 'email@address.com', 'http://ksylvest.com/', '2013-01-11 07:33:35', '2013-01-11 07:33:35', 712064548, 637242267) Fixture Delete (0.4ms) DELETE FROM "groups" Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Developer', '2013-01-11 07:33:35', '2013-01-11 07:33:35', 637242267) Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Designer', '2013-01-11 07:33:35', '2013-01-11 07:33:35', 866180701) Fixture Delete (0.3ms) DELETE FROM "users" Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:33:35', '2013-01-11 07:33:35', 980190962) Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:33:35', '2013-01-11 07:33:35', 298486374)  (0.8ms) commit transaction  (0.0ms) begin transaction Started POST "/contacts" for 127.0.0.1 at 2013-01-10 23:33:35 -0800 Processing by ContactsController#create as HTML  (0.1ms) SAVEPOINT active_record_1  (0.1ms) ROLLBACK TO SAVEPOINT active_record_1 Group Load (0.3ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (33.4ms) Rendered contacts/new.html.haml within layouts/application (43.3ms) Completed 200 OK in 177ms (Views: 54.9ms | ActiveRecord: 0.3ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (3.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]]  (0.2ms) SELECT COUNT(*) FROM "contacts" Processing by ContactsController#create as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:33:35 UTC", "updated_at"=>"2013-01-11 07:33:35 UTC"}} WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.2ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached SQL (1.0ms) INSERT INTO "contacts" ("avatar_extension", "avatar_identifier", "avatar_size", "created_at", "details", "email", "group_id", "name", "phone", "slug", "updated_at", "url") VALUES (?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?) [["avatar_extension", nil], ["avatar_identifier", nil], ["avatar_size", nil], ["created_at", Fri, 11 Jan 2013 07:33:35 UTC +00:00], ["details", "A Ruby on Rails and Cocoa developer..."], ["email", "email@address.com"], ["group_id", 637242267], ["name", "Kevin"], ["phone", "(555) 555-5555"], ["slug", nil], ["updated_at", Fri, 11 Jan 2013 07:33:35 UTC +00:00], ["url", "http://ksylvest.com/"]]  (0.1ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 26ms (ActiveRecord: 0.0ms)  (0.1ms) SELECT COUNT(*) FROM "contacts"   (0.7ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#edit as HTML Parameters: {"id"=>"712064548"} Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (18.6ms) Completed 200 OK in 27ms (Views: 24.8ms | ActiveRecord: 0.3ms)  (0.1ms) rollback transaction  (0.0ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#index as HTML Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" Completed 200 OK in 12ms (Views: 9.6ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.0ms) begin transaction Contact Load (0.3ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#new as HTML Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (19.5ms) Completed 200 OK in 23ms (Views: 22.1ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#update as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:33:35 UTC", "updated_at"=>"2013-01-11 07:33:35 UTC"}, "id"=>"712064548"} Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.1ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached  (0.1ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 8ms (ActiveRecord: 0.0ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.0ms) rollback transaction  (0.0ms) begin transaction Processing by MainController#index as HTML Completed 200 OK in 8ms (Views: 7.8ms | ActiveRecord: 0.0ms)  (0.1ms) rollback transaction Connecting to database specified by database.yml  (0.5ms) begin transaction Fixture Delete (0.3ms) DELETE FROM "contacts" Fixture Insert (0.3ms) INSERT INTO "contacts" ("name", "details", "phone", "email", "url", "created_at", "updated_at", "id", "group_id") VALUES ('Kevin', 'A Ruby on Rails and Cocoa developer...', '(555) 555-5555', 'email@address.com', 'http://ksylvest.com/', '2013-01-11 07:36:00', '2013-01-11 07:36:00', 712064548, 637242267) Fixture Delete (0.1ms) DELETE FROM "groups" Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Developer', '2013-01-11 07:36:00', '2013-01-11 07:36:00', 637242267) Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Designer', '2013-01-11 07:36:00', '2013-01-11 07:36:00', 866180701) Fixture Delete (0.2ms) DELETE FROM "users" Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:36:00', '2013-01-11 07:36:00', 980190962) Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:36:00', '2013-01-11 07:36:00', 298486374)  (0.6ms) commit transaction  (0.0ms) begin transaction Started POST "/contacts" for 127.0.0.1 at 2013-01-10 23:36:00 -0800 Processing by ContactsController#create as HTML  (0.1ms) SAVEPOINT active_record_1  (0.1ms) ROLLBACK TO SAVEPOINT active_record_1 Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (31.4ms) Rendered contacts/new.html.haml within layouts/application (41.2ms) Completed 200 OK in 156ms (Views: 53.2ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (4.5ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]]  (0.2ms) SELECT COUNT(*) FROM "contacts" Processing by ContactsController#create as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:36:00 UTC", "updated_at"=>"2013-01-11 07:36:00 UTC"}} WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.2ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached SQL (0.7ms) INSERT INTO "contacts" ("avatar_extension", "avatar_identifier", "avatar_size", "created_at", "details", "email", "group_id", "name", "phone", "slug", "updated_at", "url") VALUES (?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?) [["avatar_extension", nil], ["avatar_identifier", nil], ["avatar_size", nil], ["created_at", Fri, 11 Jan 2013 07:36:00 UTC +00:00], ["details", "A Ruby on Rails and Cocoa developer..."], ["email", "email@address.com"], ["group_id", 637242267], ["name", "Kevin"], ["phone", "(555) 555-5555"], ["slug", nil], ["updated_at", Fri, 11 Jan 2013 07:36:00 UTC +00:00], ["url", "http://ksylvest.com/"]]  (0.0ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 28ms (ActiveRecord: 0.0ms)  (0.1ms) SELECT COUNT(*) FROM "contacts"   (0.5ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#edit as HTML Parameters: {"id"=>"712064548"} Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (17.4ms) Completed 200 OK in 24ms (Views: 22.6ms | ActiveRecord: 0.3ms)  (0.1ms) rollback transaction  (0.0ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#index as HTML Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" Completed 200 OK in 10ms (Views: 8.8ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.0ms) begin transaction Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#new as HTML Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (18.1ms) Completed 200 OK in 22ms (Views: 21.0ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#update as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:36:00 UTC", "updated_at"=>"2013-01-11 07:36:00 UTC"}, "id"=>"712064548"} Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.1ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached  (0.1ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 7ms (ActiveRecord: 0.0ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction Processing by MainController#index as HTML Completed 200 OK in 6ms (Views: 5.9ms | ActiveRecord: 0.0ms)  (0.1ms) rollback transaction Connecting to database specified by database.yml  (0.5ms) begin transaction Fixture Delete (0.7ms) DELETE FROM "contacts" Fixture Insert (0.4ms) INSERT INTO "contacts" ("name", "details", "phone", "email", "url", "created_at", "updated_at", "id", "group_id") VALUES ('Kevin', 'A Ruby on Rails and Cocoa developer...', '(555) 555-5555', 'email@address.com', 'http://ksylvest.com/', '2013-01-11 07:38:58', '2013-01-11 07:38:58', 712064548, 637242267) Fixture Delete (0.1ms) DELETE FROM "groups" Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Developer', '2013-01-11 07:38:58', '2013-01-11 07:38:58', 637242267) Fixture Insert (0.1ms) INSERT INTO "groups" ("name", "created_at", "updated_at", "id") VALUES ('Designer', '2013-01-11 07:38:58', '2013-01-11 07:38:58', 866180701) Fixture Delete (0.1ms) DELETE FROM "users" Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:38:58', '2013-01-11 07:38:58', 980190962) Fixture Insert (0.1ms) INSERT INTO "users" ("name", "email", "password_digest", "created_at", "updated_at", "id") VALUES ('MyString', 'MyString', 'MyString', '2013-01-11 07:38:58', '2013-01-11 07:38:58', 298486374)  (1.1ms) commit transaction  (0.1ms) begin transaction Started POST "/contacts" for 127.0.0.1 at 2013-01-10 23:38:58 -0800 Processing by ContactsController#create as HTML  (0.1ms) SAVEPOINT active_record_1  (0.1ms) ROLLBACK TO SAVEPOINT active_record_1 Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (27.9ms) Rendered contacts/new.html.haml within layouts/application (37.3ms) Completed 200 OK in 159ms (Views: 45.2ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (4.9ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]]  (0.2ms) SELECT COUNT(*) FROM "contacts" Processing by ContactsController#create as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:38:58 UTC", "updated_at"=>"2013-01-11 07:38:58 UTC"}} WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.2ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached SQL (0.9ms) INSERT INTO "contacts" ("avatar_extension", "avatar_identifier", "avatar_size", "created_at", "details", "email", "group_id", "name", "phone", "slug", "updated_at", "url") VALUES (?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?, ?) [["avatar_extension", nil], ["avatar_identifier", nil], ["avatar_size", nil], ["created_at", Fri, 11 Jan 2013 07:38:58 UTC +00:00], ["details", "A Ruby on Rails and Cocoa developer..."], ["email", "email@address.com"], ["group_id", 637242267], ["name", "Kevin"], ["phone", "(555) 555-5555"], ["slug", nil], ["updated_at", Fri, 11 Jan 2013 07:38:58 UTC +00:00], ["url", "http://ksylvest.com/"]]  (0.1ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 31ms (ActiveRecord: 0.0ms)  (0.2ms) SELECT COUNT(*) FROM "contacts"   (1.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#edit as HTML Parameters: {"id"=>"712064548"} Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (21.9ms) Completed 200 OK in 32ms (Views: 29.7ms | ActiveRecord: 0.3ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.1ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#index as HTML Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" Completed 200 OK in 18ms (Views: 15.8ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#new as HTML Group Load (0.2ms) SELECT "groups".* FROM "groups" Rendered contacts/_form.html.haml (43.9ms) Completed 200 OK in 50ms (Views: 48.3ms | ActiveRecord: 0.2ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction Contact Load (0.4ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", 712064548]] Processing by ContactsController#update as HTML Parameters: {"contact"=>{"id"=>"712064548", "group_id"=>"637242267", "name"=>"Kevin", "slug"=>nil, "details"=>"A Ruby on Rails and Cocoa developer...", "phone"=>"(555) 555-5555", "email"=>"email@address.com", "url"=>"http://ksylvest.com/", "avatar_identifier"=>nil, "avatar_extension"=>nil, "avatar_size"=>nil, "created_at"=>"2013-01-11 07:38:58 UTC", "updated_at"=>"2013-01-11 07:38:58 UTC"}, "id"=>"712064548"} Contact Load (0.2ms) SELECT "contacts".* FROM "contacts" WHERE "contacts"."id" = ? LIMIT 1 [["id", "712064548"]] WARNING: Can't mass-assign protected attributes: id  (0.1ms) SAVEPOINT active_record_1 Group Load (0.4ms) SELECT "groups".* FROM "groups" WHERE "groups"."id" = 637242267 LIMIT 1 [attached] save attached  (0.1ms) RELEASE SAVEPOINT active_record_1 Redirected to http://test.host/contacts Completed 302 Found in 16ms (ActiveRecord: 0.0ms)  (0.1ms) rollback transaction  (0.1ms) begin transaction  (0.1ms) rollback transaction  (0.1ms) begin transaction Processing by MainController#index as HTML Completed 200 OK in 10ms (Views: 9.2ms | ActiveRecord: 0.0ms)  (0.1ms) rollback transaction