gistfile1.txt

root@chainsaw:~# tail -f -n 500 /var/log/mongodb/mongodb.log 
Mon Sep 10 03:19:46 [conn12466] query jeraff.todoList query: { creatorId: "5039fc83e4b0df076990eb26", slug: "miscellaneous-todos" } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:55658 nreturned:1 reslen:570 55ms
Mon Sep 10 03:19:51 [conn13848] end connection 192.168.254.189:40481 (425 connections now open)
Mon Sep 10 03:19:51 [initandlisten] connection accepted from 192.168.254.189:40483 #13850 (426 connections now open)
Mon Sep 10 03:19:59 [conn13849] end connection 192.168.254.82:42840 (425 connections now open)
Mon Sep 10 03:19:59 [initandlisten] connection accepted from 192.168.254.82:42843 #13851 (426 connections now open)
Mon Sep 10 03:20:21 [conn13850] end connection 192.168.254.189:40483 (425 connections now open)
Mon Sep 10 03:20:21 [initandlisten] connection accepted from 192.168.254.189:40486 #13852 (426 connections now open)
Mon Sep 10 03:20:29 [conn13851] end connection 192.168.254.82:42843 (425 connections now open)
Mon Sep 10 03:20:29 [initandlisten] connection accepted from 192.168.254.82:42845 #13853 (426 connections now open)
Mon Sep 10 03:20:51 [conn13852] end connection 192.168.254.189:40486 (425 connections now open)
Mon Sep 10 03:20:51 [initandlisten] connection accepted from 192.168.254.189:40488 #13854 (426 connections now open)
Mon Sep 10 03:20:59 [conn13853] end connection 192.168.254.82:42845 (425 connections now open)
Mon Sep 10 03:20:59 [initandlisten] connection accepted from 192.168.254.82:42848 #13855 (426 connections now open)

Mon Sep 10 03:21:21 [conn13854] end connection 192.168.254.189:40488 (425 connections now open)
Mon Sep 10 03:21:21 [initandlisten] connection accepted from 192.168.254.189:40491 #13856 (426 connections now open)
Mon Sep 10 03:21:26 [conn4603] query jeraff.oAuthToken query: { access_token: "xxxx", isActive: true } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:572767 nreturned:1 reslen:712 572ms
Mon Sep 10 03:21:26 [conn4593] query jeraff.oAuthToken query: { access_token: "xxxx", isActive: true } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:209 nreturned:1 reslen:712 585ms
Mon Sep 10 03:21:26 [conn4624] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 6 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:104119 52ms
Mon Sep 10 03:21:28 [conn4603] remove jeraff.activityStream query: { _id: ObjectId('xxxxx')} keyUpdates:0 numYields: 1 locks(micros) w:977 32ms
Mon Sep 10 03:21:29 [conn13855] end connection 192.168.254.82:42848 (425 connections now open)
Mon Sep 10 03:21:29 [initandlisten] connection accepted from 192.168.254.82:42850 #13857 (426 connections now open)
Mon Sep 10 03:21:35 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247294000|74 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:125 225ms


Mon Sep 10 03:21:51 [conn13856] end connection 192.168.254.189:40491 (425 connections now open)
Mon Sep 10 03:21:51 [initandlisten] connection accepted from 192.168.254.189:40493 #13858 (426 connections now open)
Mon Sep 10 03:21:59 [conn13857] end connection 192.168.254.82:42850 (425 connections now open)
Mon Sep 10 03:21:59 [initandlisten] connection accepted from 192.168.254.82:42853 #13859 (426 connections now open)
Mon Sep 10 03:22:07 [conn13753] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:54 reslen:3018 104ms
Mon Sep 10 03:22:07 [conn13753] profile: warning ns professor.system.profile does not exist

Mon Sep 10 03:22:07 [conn13754] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:53 reslen:3018 199ms
Mon Sep 10 03:22:10 [conn13754] command admin.$cmd command: { listDatabases: 1 } ntoreturn:1 keyUpdates:0 locks(micros) R:5 r:60 reslen:405 2829ms
Mon Sep 10 03:22:11 [conn11031] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347247331171, account.numNotifications: 0 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:1247185 623ms
Mon Sep 10 03:22:16 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247334000|28 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:106 182ms
Mon Sep 10 03:22:17 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247334000|28 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:103 83ms
Mon Sep 10 03:22:18 [conn4603] insert jeraff.userLogin keyUpdates:0 locks(micros) w:317625 317ms


Mon Sep 10 03:22:19 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247335000|162 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:89 256ms


Mon Sep 10 03:22:21 [conn13858] end connection 192.168.254.189:40493 (425 connections now open)
Mon Sep 10 03:22:21 [initandlisten] connection accepted from 192.168.254.189:40496 #13860 (426 connections now open)
Mon Sep 10 03:22:25 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247344000|102 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:228 441ms

Mon Sep 10 03:22:29 [conn13859] end connection 192.168.254.82:42853 (425 connections now open)
Mon Sep 10 03:22:29 [initandlisten] connection accepted from 192.168.254.82:42855 #13861 (426 connections now open)
Mon Sep 10 03:22:47 [conn4549] update jeraff.user query: { _id: ObjectId('xxxxx') profile: { bio: "We <3 House", hasProfilePic: true, picHash: "41c23de132bd", profilePicSource: 2, username: "houses", usernameLookup: "houses", firstName: "Houses", lastName: "Nakub", id: "504cc291e4b0f569685f99b6", email: "[email protected]", emailVerified: true, showEmail: true }, account: { connections: { facebookAccessInfo: { accessToken: "AAAC1M97ZAqLgBALCZAwr4EDREhdoZCNnhhIZCWeBeXvfe8IoUQGysrj80zsYoeL61AR1oGrhSLMpw9cYGi95fGkCOLe0kgNHptRZBviTgWgZDZD", facebookUserId: "535340615", connectTime: 1347207825425, name: "Houses Nakub", timelineShare: true, hasPublishStreamPermission: true }, twitterRefreshTime: 0, fbRefreshTime: 1347240515547 }, iphoneAppRated: false, numIPhoneRatePrompts: 0, onboardingExploreShown: true, onboardingSuggestionShown: true, onboardingActivityShown: false, onboardingRelistShown: false, listIds: [ "504cc291e4b0f569685f99b8", "504cc619e4b07f68f35530b4" ], numNotifications: 0, friendRecsHasRun: false }, stats: { numTodosCompleted: 0, numTodosOpen: 3, numTodosDueToday: 0, numFollowers: 0, numFollowees: 0, numLists: 2, numLikes: 0, numFacebookFriends: 0, numTwitterFriends: 0 }, preferences: { defaultListId: "504cc291e4b0f569685f99b8", firstDayOfWeek: 1, timezone: "Asia/Bangkok", defaultTodoPrivacy: 0, logNumDays: 7, notifications: { email: { 15: true, 16: true, 13: true, 14: true, 11: true, 12: true, 1: true, 0: true, 7: true, 5: true, 4: true, 9: true, 8: true }, ios: { 15: true, 16: true, 13: true, 14: true, 11: true, 12: true, 1: true, 0: true, 7: true, 5: true, 4: true, 9: true, 8: true } }, defaultListName: "Once...You Should Have" }, upTime: 1347247367336, insTime: 1347207825393 } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:533065 266ms
Mon Sep 10 03:22:47 [conn11051] insert jeraff.userActivity keyUpdates:0 locks(micros) w:618 294ms
Mon Sep 10 03:22:47 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:126145 247ms
Mon Sep 10 03:22:47 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:98177 98ms
Mon Sep 10 03:22:48 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247367000|1163 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:113 96ms
Mon Sep 10 03:22:48 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:109649 750ms

Mon Sep 10 03:22:51 [conn13860] end connection 192.168.254.189:40496 (425 connections now open)
Mon Sep 10 03:22:51 [initandlisten] connection accepted from 192.168.254.189:40498 #13862 (426 connections now open)
Mon Sep 10 03:22:54 [conn4549] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { profile.hasProfilePic: true, profile.picHash: "bc8381ea8fd6", upTime: 1347247369151, profile.profilePicSource: 2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:9855551 4927ms
Mon Sep 10 03:22:54 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:166 nreturned:1 reslen:227 5297ms
Mon Sep 10 03:22:54 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:98 nreturned:1 reslen:37 5054ms
Mon Sep 10 03:22:54 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:240 5382ms

Mon Sep 10 03:22:54 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:98 nreturned:22 reslen:6415 5312ms

Mon Sep 10 03:22:54 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:142796 311ms

Mon Sep 10 03:22:54 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:488 228ms
Mon Sep 10 03:22:54 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:226 200ms
Mon Sep 10 03:22:59 [conn13861] end connection 192.168.254.82:42855 (425 connections now open)
Mon Sep 10 03:22:59 [initandlisten] connection accepted from 192.168.254.82:42858 #13863 (426 connections now open)
Mon Sep 10 03:23:01 [conn13753] end connection 192.168.254.132:55322 (425 connections now open)
Mon Sep 10 03:23:01 [initandlisten] connection accepted from 192.168.254.132:60901 #13864 (426 connections now open)
Mon Sep 10 03:23:07 [conn13754] end connection 192.168.254.132:55323 (425 connections now open)
Mon Sep 10 03:23:07 [initandlisten] connection accepted from 192.168.254.132:60904 #13865 (426 connections now open)

Mon Sep 10 03:23:21 [conn13862] end connection 192.168.254.189:40498 (425 connections now open)
Mon Sep 10 03:23:21 [initandlisten] connection accepted from 192.168.254.189:40501 #13866 (426 connections now open)
Mon Sep 10 03:23:29 [conn13863] end connection 192.168.254.82:42858 (425 connections now open)
Mon Sep 10 03:23:29 [initandlisten] connection accepted from 192.168.254.82:42860 #13867 (426 connections now open)
Mon Sep 10 03:23:34 [conn4694] query jeraff.todoList query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:132764 reslen:570 132ms
Mon Sep 10 03:23:51 [conn13866] end connection 192.168.254.189:40501 (425 connections now open)
Mon Sep 10 03:23:51 [initandlisten] connection accepted from 192.168.254.189:40503 #13868 (426 connections now open)
Mon Sep 10 03:23:52 [conn12387] query jeraff.todo query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:196866 reslen:906 249ms
Mon Sep 10 03:23:56 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:195 nreturned:1 reslen:37 1808ms
Mon Sep 10 03:23:56 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:179 nreturned:1 reslen:37 1809ms
Mon Sep 10 03:23:56 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:354 nreturned:1 reslen:147 1809ms
Mon Sep 10 03:23:56 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:87 nreturned:1 reslen:147 1810ms
Mon Sep 10 03:23:56 [conn13864] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:69 reslen:2998 694ms
Mon Sep 10 03:23:56 [conn13864] profile: warning ns professor.system.profile does not exist
Mon Sep 10 03:23:56 [conn4593] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 24 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:2708617 1356ms
Mon Sep 10 03:23:59 [conn13867] end connection 192.168.254.82:42860 (425 connections now open)
Mon Sep 10 03:23:59 [initandlisten] connection accepted from 192.168.254.82:42863 #13869 (426 connections now open)
Mon Sep 10 03:24:01 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247441000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:106 103ms




Mon Sep 10 03:24:17 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247456000|52 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:97 943ms
Mon Sep 10 03:24:17 [conn4549] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 6 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:355566 177ms
Mon Sep 10 03:24:17 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 locks(micros) r:125 nreturned:1 reslen:147 1134ms
Mon Sep 10 03:24:17 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 locks(micros) r:68 nreturned:1 reslen:37 1132ms
Mon Sep 10 03:24:17 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 locks(micros) r:184 nreturned:1 reslen:147 1134ms
Mon Sep 10 03:24:17 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 locks(micros) r:212 nreturned:1 reslen:37 1133ms
Mon Sep 10 03:24:18 [conn12466] update jeraff.user query: { _id: { $in: [ ObjectId('xxxxx')] } } update: { $inc: { stats.numTodosOpen: 1 } } nscanned:1 nupdated:1 fastmod:1 keyUpdates:0 locks(micros) w:138 504ms
Mon Sep 10 03:24:18 [conn12584] insert jeraff.userActivity keyUpdates:0 locks(micros) w:1004211 502ms
Mon Sep 10 03:24:21 [conn13868] end connection 192.168.254.189:40503 (425 connections now open)
Mon Sep 10 03:24:21 [initandlisten] connection accepted from 192.168.254.189:40506 #13870 (426 connections now open)
Mon Sep 10 03:24:21 [conn4738] insert jeraff.oAuthToken keyUpdates:0 locks(micros) w:158763 246ms
Mon Sep 10 03:24:29 [conn13869] end connection 192.168.254.82:42863 (425 connections now open)
Mon Sep 10 03:24:29 [initandlisten] connection accepted from 192.168.254.82:42865 #13871 (426 connections now open)
Mon Sep 10 03:24:51 [conn12409] query jeraff.todoList query: { creatorId: "7878787", slug: "cities-to-visit" } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:191583 nreturned:1 reslen:900 191ms
Mon Sep 10 03:24:51 [conn13870] end connection 192.168.254.189:40506 (425 connections now open)
Mon Sep 10 03:24:51 [initandlisten] connection accepted from 192.168.254.189:40508 #13872 (426 connections now open)
Mon Sep 10 03:24:59 [conn13871] end connection 192.168.254.82:42865 (425 connections now open)
Mon Sep 10 03:24:59 [initandlisten] connection accepted from 192.168.254.82:42868 #13873 (426 connections now open)
Mon Sep 10 03:25:21 [conn13872] end connection 192.168.254.189:40508 (425 connections now open)
Mon Sep 10 03:25:21 [initandlisten] connection accepted from 192.168.254.189:40511 #13874 (426 connections now open)
Mon Sep 10 03:25:29 [conn13873] end connection 192.168.254.82:42868 (425 connections now open)
Mon Sep 10 03:25:29 [initandlisten] connection accepted from 192.168.254.82:42870 #13875 (426 connections now open)
Mon Sep 10 03:25:51 [conn13874] end connection 192.168.254.189:40511 (425 connections now open)
Mon Sep 10 03:25:51 [initandlisten] connection accepted from 192.168.254.189:40513 #13876 (426 connections now open)
Mon Sep 10 03:25:59 [conn13875] end connection 192.168.254.82:42870 (425 connections now open)
Mon Sep 10 03:25:59 [initandlisten] connection accepted from 192.168.254.82:42873 #13877 (426 connections now open)
Mon Sep 10 03:26:01 [conn13835] end connection 192.168.254.132:41390 (425 connections now open)
Mon Sep 10 03:26:01 [initandlisten] connection accepted from 192.168.254.132:60935 #13878 (426 connections now open)
Mon Sep 10 03:26:21 [conn13876] end connection 192.168.254.189:40513 (425 connections now open)
Mon Sep 10 03:26:21 [initandlisten] connection accepted from 192.168.254.189:40516 #13879 (426 connections now open)
Mon Sep 10 03:26:28 [conn12584] query jeraff.invitation query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:780706 reslen:580 780ms
Mon Sep 10 03:26:28 [conn12584] query jeraff.todoList query: { creatorId: "djnjdndj", slug: "miscellaneous-todos" } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:236 nreturned:1 reslen:570 107ms
Mon Sep 10 03:26:29 [conn13877] end connection 192.168.254.82:42873 (425 connections now open)
Mon Sep 10 03:26:29 [initandlisten] connection accepted from 192.168.254.82:42875 #13880 (426 connections now open)
Mon Sep 10 03:26:36 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247596000|2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:97 34ms
Mon Sep 10 03:26:36 [conn4624] remove jeraff.activityStream query: { _id: ObjectId('xxxxx')} keyUpdates:0 numYields: 1 locks(micros) w:186 136ms




Mon Sep 10 03:26:49 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:154 nreturned:1 reslen:685 1649ms
Mon Sep 10 03:26:49 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:76 nreturned:1 reslen:685 1649ms
Mon Sep 10 03:26:49 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:83 nreturned:1 reslen:37 1648ms
Mon Sep 10 03:26:49 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:83 nreturned:1 reslen:37 1634ms

Mon Sep 10 03:26:51 [conn13879] end connection 192.168.254.189:40516 (425 connections now open)
Mon Sep 10 03:26:51 [initandlisten] connection accepted from 192.168.254.189:40518 #13881 (426 connections now open)
Mon Sep 10 03:26:59 [conn13880] end connection 192.168.254.82:42875 (425 connections now open)
Mon Sep 10 03:26:59 [initandlisten] connection accepted from 192.168.254.82:42878 #13882 (426 connections now open)
Mon Sep 10 03:27:12 [conn4777] insert jeraff.userLogin keyUpdates:0 locks(micros) w:780027 394ms
Mon Sep 10 03:27:13 [conn12387] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 18 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:64 1058ms
Mon Sep 10 03:27:13 [conn4593] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { profile.hasProfilePic: true, profile.picHash: "0479da543d36", upTime: 1347247632261, profile.profilePicSource: 2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:1883804 941ms
Mon Sep 10 03:27:16 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247635000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:75 184ms
Mon Sep 10 03:27:21 [conn13881] end connection 192.168.254.189:40518 (425 connections now open)
Mon Sep 10 03:27:21 [initandlisten] connection accepted from 192.168.254.189:40521 #13883 (426 connections now open)
Mon Sep 10 03:27:29 [conn13882] end connection 192.168.254.82:42878 (425 connections now open)
Mon Sep 10 03:27:29 [initandlisten] connection accepted from 192.168.254.82:42880 #13884 (426 connections now open)
Mon Sep 10 03:27:39 [conn12387] query jeraff.invitation query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:175327 reslen:579 175ms
Mon Sep 10 03:27:51 [conn13883] end connection 192.168.254.189:40521 (425 connections now open)
Mon Sep 10 03:27:51 [initandlisten] connection accepted from 192.168.254.189:40523 #13885 (426 connections now open)
Mon Sep 10 03:27:59 [conn13884] end connection 192.168.254.82:42880 (425 connections now open)
Mon Sep 10 03:27:59 [initandlisten] connection accepted from 192.168.254.82:42883 #13886 (426 connections now open)
Mon Sep 10 03:28:10 [conn4624] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347247690558, shortUrl: "http://well.ly/S1QLI3" } } nscanned:1 nmoved:1 nupdated:1 keyUpdates:0 locks(micros) w:62419 62ms
Mon Sep 10 03:28:11 [conn4738] update jeraff.SubjectCommenters query: { subjectId: "5049ca94e4b0d0954ff9900a", type: 1 } update: { $push: { commenterIds: "4d9ca8feca1cacfcabcce1f7" } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:1486 68ms
Mon Sep 10 03:28:21 [conn13885] end connection 192.168.254.189:40523 (425 connections now open)
Mon Sep 10 03:28:21 [initandlisten] connection accepted from 192.168.254.189:40526 #13887 (426 connections now open)


Mon Sep 10 03:28:29 [conn13886] end connection 192.168.254.82:42883 (425 connections now open)
Mon Sep 10 03:28:29 [initandlisten] connection accepted from 192.168.254.82:42885 #13888 (426 connections now open)
Mon Sep 10 03:28:50 [conn4738] insert jeraff.activityStream keyUpdates:0 locks(micros) w:808892 404ms
Mon Sep 10 03:28:51 [conn13887] end connection 192.168.254.189:40526 (425 connections now open)
Mon Sep 10 03:28:51 [initandlisten] connection accepted from 192.168.254.189:40528 #13889 (426 connections now open)
Mon Sep 10 03:28:52 [conn4738] insert jeraff.activityStream keyUpdates:0 locks(micros) w:47168 24ms
Mon Sep 10 03:28:54 [conn4593] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "503c2fa1e4b0b9a34e5ff0c9", todoId: "50423121e4b0a5989fa81f58", todoListId: "504129a1e4b010e1ada5e759", actorId: "504129a1e4b010e1ada5e758", activityType: 1, upTime: 1347247733868, insTime: 1346515233296 } idhack:1 nupdated:1 keyUpdates:1 locks(micros) w:164977 696ms
Mon Sep 10 03:28:54 [conn4593] insert jeraff.notification keyUpdates:0 locks(micros) w:1084 62ms
Mon Sep 10 03:28:59 [conn13888] end connection 192.168.254.82:42885 (425 connections now open)
Mon Sep 10 03:28:59 [initandlisten] connection accepted from 192.168.254.82:42888 #13890 (426 connections now open)
Mon Sep 10 03:29:02 [conn4738] insert jeraff.activityStream keyUpdates:0 locks(micros) w:73650 37ms
Mon Sep 10 03:29:21 [conn13889] end connection 192.168.254.189:40528 (425 connections now open)
Mon Sep 10 03:29:21 [initandlisten] connection accepted from 192.168.254.189:40531 #13891 (426 connections now open)
Mon Sep 10 03:29:25 [conn4602] update jeraff.todoSuggestion query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347247765555, pending: false, todoId: "504d5e95e4b07f68f35d4eec" } } nscanned:1 nmoved:1 nupdated:1 keyUpdates:0 locks(micros) w:66381 66ms
Mon Sep 10 03:29:25 [conn4655] insert jeraff.activityStream keyUpdates:0 locks(micros) w:66488 33ms
Mon Sep 10 03:29:29 [conn13890] end connection 192.168.254.82:42888 (425 connections now open)
Mon Sep 10 03:29:29 [initandlisten] connection accepted from 192.168.254.82:42890 #13892 (426 connections now open)
Mon Sep 10 03:29:34 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247774000|2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:78 67ms
Mon Sep 10 03:29:51 [conn13891] end connection 192.168.254.189:40531 (425 connections now open)
Mon Sep 10 03:29:51 [initandlisten] connection accepted from 192.168.254.189:40533 #13893 (426 connections now open)
Mon Sep 10 03:29:59 [conn13892] end connection 192.168.254.82:42890 (425 connections now open)
Mon Sep 10 03:29:59 [initandlisten] connection accepted from 192.168.254.82:42893 #13894 (426 connections now open)
Mon Sep 10 03:30:01 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247800000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:137 96ms
Mon Sep 10 03:30:10 [conn12466] query jeraff.user query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:49901 reslen:1715 49ms
Mon Sep 10 03:30:21 [conn13893] end connection 192.168.254.189:40533 (425 connections now open)
Mon Sep 10 03:30:21 [initandlisten] connection accepted from 192.168.254.189:40536 #13895 (426 connections now open)
Mon Sep 10 03:30:27 [conn12387] query jeraff.invitation query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:73119 reslen:650 73ms
Mon Sep 10 03:30:29 [conn13894] end connection 192.168.254.82:42893 (425 connections now open)
Mon Sep 10 03:30:29 [initandlisten] connection accepted from 192.168.254.82:42895 #13896 (426 connections now open)
Mon Sep 10 03:30:33 [conn12466] insert jeraff.activityStream keyUpdates:0 locks(micros) w:573020 286ms
Mon Sep 10 03:30:35 [conn4618] update jeraff.todoSuggestion query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347247835246, shortUrl: "http://well.ly/S1Rau2" } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:169151 84ms
Mon Sep 10 03:30:35 [conn4655] insert jeraff.userActivity keyUpdates:0 locks(micros) w:174 154ms
Mon Sep 10 03:30:51 [conn13895] end connection 192.168.254.189:40536 (425 connections now open)
Mon Sep 10 03:30:51 [initandlisten] connection accepted from 192.168.254.189:40538 #13897 (426 connections now open)
Mon Sep 10 03:30:59 [conn13896] end connection 192.168.254.82:42895 (425 connections now open)
Mon Sep 10 03:30:59 [initandlisten] connection accepted from 192.168.254.82:42898 #13898 (426 connections now open)
Mon Sep 10 03:31:13 [conn4810] query jeraff.oAuthToken query: { access_token: "a795b6356164f10cd0fad8741b9664e0d015f1c0", isActive: true } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:188 nreturned:1 reslen:699 40ms
Mon Sep 10 03:31:15 [conn4626] remove jeraff.activityStream query: { _id: ObjectId('xxxxx')} keyUpdates:0 numYields: 1 locks(micros) w:298 66ms



Mon Sep 10 03:31:19 [conn4626] insert jeraff.activityStream keyUpdates:0 locks(micros) w:118079 59ms
Mon Sep 10 03:31:20 [conn4626] insert jeraff.activityStream keyUpdates:0 locks(micros) w:117225 58ms
Mon Sep 10 03:31:21 [conn13897] end connection 192.168.254.189:40538 (425 connections now open)
Mon Sep 10 03:31:21 [initandlisten] connection accepted from 192.168.254.189:40541 #13899 (426 connections now open)
Mon Sep 10 03:31:29 [conn13898] end connection 192.168.254.82:42898 (425 connections now open)
Mon Sep 10 03:31:29 [initandlisten] connection accepted from 192.168.254.82:42900 #13900 (426 connections now open)
Mon Sep 10 03:31:30 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:168 nreturned:2 reslen:614 1186ms
Mon Sep 10 03:31:30 [conn4777] insert jeraff.activityStream keyUpdates:0 locks(micros) w:2369852 1185ms
Mon Sep 10 03:31:30 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:222 nreturned:2 reslen:614 1186ms
Mon Sep 10 03:31:41 [conn4603] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 104 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:492936 246ms

Mon Sep 10 03:31:47 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247906000|534 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:146 824ms
Mon Sep 10 03:31:47 [conn4810] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { profile.hasProfilePic: true, profile.picHash: "1f549141e0cd", upTime: 1347247907232, profile.profilePicSource: 2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:529849 529ms
Mon Sep 10 03:31:51 [conn13899] end connection 192.168.254.189:40541 (425 connections now open)
Mon Sep 10 03:31:51 [initandlisten] connection accepted from 192.168.254.189:40543 #13901 (426 connections now open)
Mon Sep 10 03:31:59 [conn13900] end connection 192.168.254.82:42900 (425 connections now open)
Mon Sep 10 03:31:59 [initandlisten] connection accepted from 192.168.254.82:42903 #13902 (426 connections now open)

Mon Sep 10 03:32:04 [conn4626] remove jeraff.ForeignUser query: { userId: "4e1dd9d9ca1ca4bf90112fe1", foreignType: 2 } keyUpdates:0 locks(micros) w:162619 81ms



Mon Sep 10 03:32:17 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247936000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:112 608ms
Mon Sep 10 03:32:18 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247938000|4 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:486 216ms
Mon Sep 10 03:32:21 [conn13901] end connection 192.168.254.189:40543 (425 connections now open)
Mon Sep 10 03:32:21 [initandlisten] connection accepted from 192.168.254.189:40546 #13903 (426 connections now open)
Mon Sep 10 03:32:23 [conn4549] remove jeraff.activityStream query: { _id: ObjectId('xxxxx')} keyUpdates:0 numYields: 1 locks(micros) w:406 30ms
Mon Sep 10 03:32:29 [conn13902] end connection 192.168.254.82:42903 (425 connections now open)
Mon Sep 10 03:32:29 [initandlisten] connection accepted from 192.168.254.82:42905 #13904 (426 connections now open)
Mon Sep 10 03:32:37 [conn4810] insert jeraff.todo keyUpdates:0 locks(micros) w:375 69ms
Mon Sep 10 03:32:51 [conn13903] end connection 192.168.254.189:40546 (425 connections now open)
Mon Sep 10 03:32:51 [initandlisten] connection accepted from 192.168.254.189:40548 #13905 (426 connections now open)
Mon Sep 10 03:32:59 [conn13904] end connection 192.168.254.82:42905 (425 connections now open)
Mon Sep 10 03:32:59 [initandlisten] connection accepted from 192.168.254.82:42908 #13906 (426 connections now open)
Mon Sep 10 03:33:02 [conn12466] query jeraff.todoList query: { creatorId: "503d714ae4b00f9bfddd1678", slug: "movies-to-see" } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:191 nreturned:1 reslen:608 103ms
Mon Sep 10 03:33:02 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347247982000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:104 43ms
Mon Sep 10 03:33:09 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:85 nreturned:1 reslen:317 1502ms
Mon Sep 10 03:33:09 [conn4694] insert jeraff.activityStream keyUpdates:0 locks(micros) w:3004968 1502ms
Mon Sep 10 03:33:21 [conn13905] end connection 192.168.254.189:40548 (425 connections now open)
Mon Sep 10 03:33:21 [initandlisten] connection accepted from 192.168.254.189:40551 #13907 (426 connections now open)
Mon Sep 10 03:33:29 [conn13906] end connection 192.168.254.82:42908 (425 connections now open)
Mon Sep 10 03:33:29 [initandlisten] connection accepted from 192.168.254.82:42910 #13908 (426 connections now open)
Mon Sep 10 03:33:41 [conn4810] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoId: "504a6ffde4b0d01f0a2cae64", todoListId: "504a6fa1e4b0df35472edf49", actorId: "504a63b9e4b0f1fb520562de", activityType: 1, upTime: 1347248021720, insTime: 1347055613421 } nscanned:0 idhack:1 nupdated:1 upsert:1 keyUpdates:0 locks(micros) w:223 189ms
Mon Sep 10 03:33:45 [conn4694] insert jeraff.relationship keyUpdates:0 locks(micros) w:91840 269ms
Mon Sep 10 03:33:45 [conn4694] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoListId: "504aa58ae4b0930c79fd05b4", suggestionId: "504aa71be4b0930c79fd303d", actorId: "50444460e4b0fae8886ee923", activityType: 13, upTime: 1347248024863, insTime: 1347069723164 } nscanned:0 idhack:1 nupdated:1 upsert:1 keyUpdates:0 locks(micros) w:3210 186ms
Mon Sep 10 03:33:51 [conn13907] end connection 192.168.254.189:40551 (425 connections now open)
Mon Sep 10 03:33:51 [initandlisten] connection accepted from 192.168.254.189:40553 #13909 (426 connections now open)
Mon Sep 10 03:33:53 [conn4694] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoId: "50447597e4b0b97aa5474a43", todoListId: "5044702be4b00941127b76a8", actorId: "50447002e4b0d66996df8559", activityType: 0, upTime: 1347248032930, insTime: 1346674283225 } idhack:1 nupdated:1 keyUpdates:1 locks(micros) w:183479 207ms
Mon Sep 10 03:33:54 [conn4694] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoId: "50447597e4b0b97aa5474a43", todoListId: "5044702be4b00941127b76a8", actorId: "50447002e4b0d66996df8559", activityType: 1, upTime: 1347248032930, insTime: 1346663831485 } idhack:1 nupdated:1 keyUpdates:1 locks(micros) w:68292 856ms
Mon Sep 10 03:33:54 [conn4694] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoListId: "5044702be4b00941127b76a8", actorId: "50447002e4b0d66996df8559", activityType: 7, upTime: 1347248032930, insTime: 1346662443285 } idhack:1 nupdated:1 keyUpdates:1 locks(micros) w:2405 134ms
Mon Sep 10 03:33:55 [conn4810] update jeraff.activityStream query: { _id: ObjectId('xxxxx') userId: "xxx", todoListId: "5042cb3be4b07af2fe71b15a", actorId: "5042cae4e4b0da909c795a2a", activityType: 7, upTime: 1347248035232, insTime: 1346554683101 } idhack:1 nupdated:1 keyUpdates:1 locks(micros) w:121471 121ms
Mon Sep 10 03:34:00 [conn13908] end connection 192.168.254.82:42910 (425 connections now open)
Mon Sep 10 03:34:00 [initandlisten] connection accepted from 192.168.254.82:42913 #13910 (426 connections now open)
Mon Sep 10 03:34:21 [conn13909] end connection 192.168.254.189:40553 (425 connections now open)
Mon Sep 10 03:34:21 [initandlisten] connection accepted from 192.168.254.189:40556 #13911 (426 connections now open)
Mon Sep 10 03:34:30 [conn13910] end connection 192.168.254.82:42913 (425 connections now open)
Mon Sep 10 03:34:30 [initandlisten] connection accepted from 192.168.254.82:42915 #13912 (426 connections now open)
Mon Sep 10 03:34:42 [conn4549] key seems to have moved in the index, refinding. 3:1b345000
Mon Sep 10 03:34:43 [conn4694] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347248083385, account.numNotifications: 0 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:32742 32ms

Mon Sep 10 03:34:44 [conn4544] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { profile.hasProfilePic: true, profile.picHash: "7281c2c6c29a", upTime: 1347248084067, profile.profilePicSource: 2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:236146 118ms

Mon Sep 10 03:34:51 [conn13911] end connection 192.168.254.189:40556 (425 connections now open)
Mon Sep 10 03:34:51 [initandlisten] connection accepted from 192.168.254.189:40558 #13913 (426 connections now open)
Mon Sep 10 03:34:52 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248090000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:130 1062ms
Mon Sep 10 03:34:52 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:174 nreturned:1 reslen:37 1231ms

Mon Sep 10 03:34:52 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:89 nreturned:1 reslen:350 1231ms
Mon Sep 10 03:34:52 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:92 nreturned:1 reslen:37 1231ms
Mon Sep 10 03:34:52 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 locks(micros) r:49 nreturned:1 reslen:350 1232ms



Mon Sep 10 03:35:00 [conn13912] end connection 192.168.254.82:42915 (425 connections now open)
Mon Sep 10 03:35:00 [initandlisten] connection accepted from 192.168.254.82:42918 #13914 (426 connections now open)

Mon Sep 10 03:35:00 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248097000|101 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:549 2772ms
Mon Sep 10 03:35:01 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248100000|61 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:123 75ms



Mon Sep 10 03:35:17 [conn4810] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { numComments: 3 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:2172367 1086ms
Mon Sep 10 03:35:17 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:400 nreturned:1 reslen:37 1440ms
Mon Sep 10 03:35:17 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:95 nreturned:1 reslen:37 1440ms
Mon Sep 10 03:35:17 [conn13865] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:70 reslen:2998 805ms
Mon Sep 10 03:35:17 [conn13865] profile: warning ns professor.system.profile does not exist

Mon Sep 10 03:35:17 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:111 nreturned:3 reslen:812 1443ms
Mon Sep 10 03:35:17 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 locks(micros) r:54 nreturned:3 reslen:812 1443ms

Mon Sep 10 03:35:20 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 locks(micros) r:114 nreturned:5 reslen:1656 2143ms
Mon Sep 10 03:35:20 [conn266] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697955646275586) } } cursorid:6221028563562291266 ntoreturn:0 keyUpdates:0 locks(micros) r:149 nreturned:5 reslen:105 2143ms
Mon Sep 10 03:35:20 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 locks(micros) r:79 nreturned:5 reslen:1656 2144ms
Mon Sep 10 03:35:21 [conn13913] end connection 192.168.254.189:40558 (425 connections now open)
Mon Sep 10 03:35:21 [initandlisten] connection accepted from 192.168.254.189:40561 #13915 (426 connections now open)
Mon Sep 10 03:35:30 [conn13914] end connection 192.168.254.82:42918 (425 connections now open)
Mon Sep 10 03:35:30 [initandlisten] connection accepted from 192.168.254.82:42920 #13916 (426 connections now open)
Mon Sep 10 03:35:30 [conn11072] update jeraff.SubjectCommenters query: { subjectId: "50479709e4b03290d5713a5b", type: 0 } update: { $push: { commenterIds: "4f5134a4ca1cd4f9372d8c6a" } } nscanned:1 nmoved:1 nupdated:1 keyUpdates:0 locks(micros) w:1157 43ms
Mon Sep 10 03:35:32 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248131000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:112 874ms
Mon Sep 10 03:35:32 [conn4655] insert jeraff.ListInteraction keyUpdates:0 locks(micros) w:358043 179ms

Mon Sep 10 03:35:34 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248134000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:130 125ms

Mon Sep 10 03:35:38 [conn12466] update jeraff.SubjectCommenters query: { subjectId: "503a6ca5e4b085310afcfdc4", type: 0 } update: { $push: { commenterIds: "4f5a5a94ca1c990ae48ca87c" } } nscanned:0 nupdated:1 fastmodinsert:1 keyUpdates:0 locks(micros) w:125857 125ms
Mon Sep 10 03:35:51 [conn13915] end connection 192.168.254.189:40561 (425 connections now open)
Mon Sep 10 03:35:51 [initandlisten] connection accepted from 192.168.254.189:40563 #13917 (426 connections now open)
Mon Sep 10 03:35:55 [conn12584] insert jeraff.activityStream keyUpdates:0 locks(micros) w:12968574 12969ms
Mon Sep 10 03:35:55 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:819 nreturned:1 reslen:317 12961ms
Mon Sep 10 03:35:55 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:1006 nreturned:1 reslen:317 12961ms
Mon Sep 10 03:35:55 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:1172 nreturned:1 reslen:37 12960ms
Mon Sep 10 03:35:55 [conn13865] serverStatus was very slow: { after basic: 0, middle of mem: 0, after mem: 0, after connections: 0, after extra info: 0, after counters: 0, after repl: 0, after asserts: 0, after dur: 10258, at end: 10258 }
Mon Sep 10 03:35:55 [conn13865] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:60 reslen:3189 10671ms
Mon Sep 10 03:35:55 [conn13865] profile: warning ns professor.system.profile does not exist
Mon Sep 10 03:35:55 [conn13865] command admin.$cmd command: { listDatabases: 1 } ntoreturn:1 keyUpdates:0 locks(micros) R:7 r:55 reslen:405 38ms
Mon Sep 10 03:35:56 [conn12584] insert jeraff.activityStream keyUpdates:0 locks(micros) w:1048113 524ms

Mon Sep 10 03:35:56 [conn12584] insert jeraff.activityStream keyUpdates:0 locks(micros) w:56166 28ms
Mon Sep 10 03:36:00 [conn13916] end connection 192.168.254.82:42920 (425 connections now open)
Mon Sep 10 03:36:00 [initandlisten] connection accepted from 192.168.254.82:42923 #13918 (426 connections now open)
Mon Sep 10 03:36:01 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248141000|472 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:135 209ms
Mon Sep 10 03:36:01 [conn13878] end connection 192.168.254.132:60935 (425 connections now open)
Mon Sep 10 03:36:01 [initandlisten] connection accepted from 192.168.254.132:44183 #13919 (426 connections now open)

Mon Sep 10 03:36:19 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:41924 21ms
Mon Sep 10 03:36:19 [conn4614] insert jeraff.relationship keyUpdates:0 locks(micros) w:61556 61ms
Mon Sep 10 03:36:19 [conn11031] insert jeraff.activityStream keyUpdates:0 locks(micros) w:52849 26ms
Mon Sep 10 03:36:20 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:199548 99ms
Mon Sep 10 03:36:21 [conn13917] end connection 192.168.254.189:40563 (425 connections now open)
Mon Sep 10 03:36:21 [initandlisten] connection accepted from 192.168.254.189:40566 #13920 (427 connections now open)
Mon Sep 10 03:36:30 [conn13918] end connection 192.168.254.82:42923 (425 connections now open)
Mon Sep 10 03:36:30 [initandlisten] connection accepted from 192.168.254.82:42925 #13921 (426 connections now open)
Mon Sep 10 03:36:30 [conn4628] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 51 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:110097 55ms
Mon Sep 10 03:36:41 [conn12584] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { numHearts: 1 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:43016 21ms
Mon Sep 10 03:36:51 [conn13920] end connection 192.168.254.189:40566 (425 connections now open)
Mon Sep 10 03:36:51 [initandlisten] connection accepted from 192.168.254.189:40568 #13922 (426 connections now open)
Mon Sep 10 03:37:00 [conn13921] end connection 192.168.254.82:42925 (425 connections now open)
Mon Sep 10 03:37:00 [initandlisten] connection accepted from 192.168.254.82:42928 #13923 (426 connections now open)
Mon Sep 10 03:37:01 [conn12376] insert jeraff.activityStream keyUpdates:0 locks(micros) w:561761 282ms
Mon Sep 10 03:37:21 [conn13922] end connection 192.168.254.189:40568 (425 connections now open)
Mon Sep 10 03:37:21 [initandlisten] connection accepted from 192.168.254.189:40571 #13924 (426 connections now open)

Mon Sep 10 03:37:30 [conn13923] end connection 192.168.254.82:42928 (425 connections now open)
Mon Sep 10 03:37:30 [initandlisten] connection accepted from 192.168.254.82:42930 #13925 (426 connections now open)
Mon Sep 10 03:37:32 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248252000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:82 67ms
Mon Sep 10 03:37:51 [conn13924] end connection 192.168.254.189:40571 (425 connections now open)
Mon Sep 10 03:37:51 [initandlisten] connection accepted from 192.168.254.189:40573 #13926 (426 connections now open)
Mon Sep 10 03:38:00 [conn13925] end connection 192.168.254.82:42930 (425 connections now open)
Mon Sep 10 03:38:00 [initandlisten] connection accepted from 192.168.254.82:42933 #13927 (426 connections now open)
Mon Sep 10 03:38:06 [conn4777] query jeraff.user query: { _id: ObjectId('xxxxx')} ntoreturn:1 idhack:1 keyUpdates:0 locks(micros) r:91751 reslen:1470 91ms

Mon Sep 10 03:38:06 [conn4634] insert jeraff.userLogin keyUpdates:0 locks(micros) w:409341 204ms

Mon Sep 10 03:38:17 [conn4655] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 7 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:86054 43ms
Mon Sep 10 03:38:21 [conn13926] end connection 192.168.254.189:40573 (425 connections now open)
Mon Sep 10 03:38:21 [initandlisten] connection accepted from 192.168.254.189:40576 #13928 (427 connections now open)
Mon Sep 10 03:38:28 [conn4777] insert jeraff.relationship keyUpdates:0 locks(micros) w:519 158ms
Mon Sep 10 03:38:28 [conn13318] insert jeraff.activityStream keyUpdates:0 locks(micros) w:42882 22ms
Mon Sep 10 03:38:30 [conn13927] end connection 192.168.254.82:42933 (425 connections now open)
Mon Sep 10 03:38:30 [initandlisten] connection accepted from 192.168.254.82:42935 #13929 (426 connections now open)
Mon Sep 10 03:38:36 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:45320 23ms
Mon Sep 10 03:38:38 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:43958 22ms
Mon Sep 10 03:38:51 [conn13928] end connection 192.168.254.189:40576 (425 connections now open)
Mon Sep 10 03:38:51 [initandlisten] connection accepted from 192.168.254.189:40578 #13930 (426 connections now open)
Mon Sep 10 03:39:00 [conn13929] end connection 192.168.254.82:42935 (425 connections now open)
Mon Sep 10 03:39:00 [initandlisten] connection accepted from 192.168.254.82:42938 #13931 (426 connections now open)
Mon Sep 10 03:39:16 [conn13318] insert jeraff.activityStream keyUpdates:0 locks(micros) w:1513718 756ms

Mon Sep 10 03:39:21 [conn13930] end connection 192.168.254.189:40578 (425 connections now open)
Mon Sep 10 03:39:21 [initandlisten] connection accepted from 192.168.254.189:40581 #13932 (426 connections now open)

Mon Sep 10 03:39:29 [conn13318] insert jeraff.activityStream keyUpdates:0 locks(micros) w:51203 25ms
Mon Sep 10 03:39:29 [conn13318] insert jeraff.activityStream keyUpdates:0 locks(micros) w:22009 21ms
Mon Sep 10 03:39:30 [conn13318] insert jeraff.activityStream keyUpdates:0 locks(micros) w:89935 45ms

Mon Sep 10 03:39:30 [conn13931] end connection 192.168.254.82:42938 (425 connections now open)
Mon Sep 10 03:39:30 [initandlisten] connection accepted from 192.168.254.82:42940 #13933 (426 connections now open)
Mon Sep 10 03:39:43 [conn12584] insert jeraff.userActivity keyUpdates:0 locks(micros) w:1576181 788ms
Mon Sep 10 03:39:45 [conn12466] insert jeraff.activityStream keyUpdates:0 locks(micros) w:2786107 1393ms
Mon Sep 10 03:39:45 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:465 nreturned:1 reslen:317 1396ms
Mon Sep 10 03:39:45 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:438 nreturned:1 reslen:317 1397ms
Mon Sep 10 03:39:45 [conn12466] insert jeraff.activityStream keyUpdates:0 locks(micros) w:57177 28ms
Mon Sep 10 03:39:51 [conn4810] query jeraff.oAuthToken query: { access_token: "7f368ddde2fa2ce6f947b51cda23a683df51a34b", isActive: true } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:157455 nreturned:1 reslen:712 157ms
Mon Sep 10 03:39:51 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248391000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:105 347ms
Mon Sep 10 03:39:51 [conn4655] query jeraff.oAuthToken query: { access_token: "7f368ddde2fa2ce6f947b51cda23a683df51a34b", isActive: true } ntoreturn:1 ntoskip:0 nscanned:1 keyUpdates:0 locks(micros) r:175 nreturned:1 reslen:712 587ms
Mon Sep 10 03:39:51 [conn4810] query jeraff.user query: { _id: ObjectId('xxxxx')} ntoreturn:1 idhack:1 keyUpdates:0 locks(micros) r:75320 reslen:1290 75ms
Mon Sep 10 03:39:51 [conn13932] end connection 192.168.254.189:40581 (425 connections now open)
Mon Sep 10 03:39:51 [initandlisten] connection accepted from 192.168.254.189:40583 #13934 (426 connections now open)
Mon Sep 10 03:39:55 [conn11051] query jeraff.invitation query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:432343 reslen:854 432ms
Mon Sep 10 03:39:56 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248396000|9 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:80 35ms
Mon Sep 10 03:40:00 [conn13933] end connection 192.168.254.82:42940 (425 connections now open)
Mon Sep 10 03:40:00 [initandlisten] connection accepted from 192.168.254.82:42943 #13935 (426 connections now open)
Mon Sep 10 03:40:03 [conn4689] insert jeraff.notification keyUpdates:0 locks(micros) w:58830 29ms
Mon Sep 10 03:40:16 [conn12376] insert jeraff.activityStream keyUpdates:0 locks(micros) w:1402079 701ms
Mon Sep 10 03:40:21 [conn13934] end connection 192.168.254.189:40583 (425 connections now open)
Mon Sep 10 03:40:21 [initandlisten] connection accepted from 192.168.254.189:40586 #13936 (426 connections now open)
Mon Sep 10 03:40:30 [conn13935] end connection 192.168.254.82:42943 (425 connections now open)
Mon Sep 10 03:40:30 [initandlisten] connection accepted from 192.168.254.82:42945 #13937 (426 connections now open)
Mon Sep 10 03:40:35 [conn12376] insert jeraff.activityStream keyUpdates:0 locks(micros) w:19477234 19477ms
Mon Sep 10 03:40:38 [conn11051] insert jeraff.comment keyUpdates:0 locks(micros) w:4743103 2371ms
Mon Sep 10 03:40:38 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:110 nreturned:2 reslen:568 2373ms
Mon Sep 10 03:40:38 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:113 nreturned:2 reslen:568 2372ms
Mon Sep 10 03:40:38 [conn13865] serverStatus was very slow: { after basic: 0, middle of mem: 0, after mem: 0, after connections: 0, after extra info: 0, after counters: 0, after repl: 0, after asserts: 0, after dur: 12355, at end: 12355 }
Mon Sep 10 03:40:38 [conn13865] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:58 reslen:3189 12456ms
Mon Sep 10 03:40:38 [conn13865] profile: warning ns professor.system.profile does not exist
Mon Sep 10 03:40:38 [conn13864] serverStatus was very slow: { after basic: 0, middle of mem: 0, after mem: 0, after connections: 0, after extra info: 0, after counters: 0, after repl: 0, after asserts: 0, after dur: 2440, at end: 2440 }
Mon Sep 10 03:40:38 [conn13864] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:59 reslen:3189 2462ms
Mon Sep 10 03:40:39 [conn12376] insert jeraff.activityStream keyUpdates:0 locks(micros) w:2081563 1045ms

Mon Sep 10 03:40:40 [initandlisten] connection accepted from 192.168.254.132:56311 #13938 (427 connections now open)
Mon Sep 10 03:40:40 [conn4654] update jeraff.user query: { _id: ObjectId('xxxxx')} update: { $set: { profile.hasProfilePic: true, profile.picHash: "d234cc0adda0", upTime: 1347248440521, profile.profilePicSource: 2 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:573433 286ms
Mon Sep 10 03:40:40 [DataFileSync] flushing mmaps took 25199ms  for 29 files
Mon Sep 10 03:40:49 [conn13938] end connection 192.168.254.132:56311 (426 connections now open)


Mon Sep 10 03:40:51 [conn13936] end connection 192.168.254.189:40586 (425 connections now open)
Mon Sep 10 03:40:51 [initandlisten] connection accepted from 192.168.254.189:40588 #13939 (426 connections now open)

Mon Sep 10 03:41:00 [conn13937] end connection 192.168.254.82:42945 (425 connections now open)
Mon Sep 10 03:41:00 [initandlisten] connection accepted from 192.168.254.82:42948 #13940 (426 connections now open)

Mon Sep 10 03:41:10 [conn12466] insert jeraff.ListInteraction keyUpdates:0 locks(micros) w:663395 331ms
Mon Sep 10 03:41:10 [conn4544] update jeraff.todoList query: { _id: ObjectId('xxxxx')} update: { $set: { totalTodos: 61 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:133617 66ms
Mon Sep 10 03:41:13 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248470000|6 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:89 2254ms
Mon Sep 10 03:41:13 [conn12387] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347248472792, completeTime: 1347248472790, isOpen: false } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:898457 898ms
Mon Sep 10 03:41:15 [conn12387] insert jeraff.activityStream keyUpdates:0 locks(micros) w:400821 201ms
Mon Sep 10 03:41:21 [conn13939] end connection 192.168.254.189:40588 (425 connections now open)
Mon Sep 10 03:41:21 [initandlisten] connection accepted from 192.168.254.189:40591 #13941 (426 connections now open)
Mon Sep 10 03:41:30 [conn13940] end connection 192.168.254.82:42948 (425 connections now open)
Mon Sep 10 03:41:30 [initandlisten] connection accepted from 192.168.254.82:42950 #13942 (426 connections now open)
Mon Sep 10 03:41:33 [conn12387] insert jeraff.activityStream keyUpdates:0 locks(micros) w:17461635 17466ms
Mon Sep 10 03:41:34 [conn11051] insert jeraff.userLogin keyUpdates:0 locks(micros) w:2222574 1111ms
Mon Sep 10 03:41:34 [conn13865] serverStatus was very slow: { after basic: 0, middle of mem: 0, after mem: 0, after connections: 0, after extra info: 0, after counters: 0, after repl: 0, after asserts: 0, after dur: 2220, at end: 2220 }
Mon Sep 10 03:41:34 [conn13865] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:56 reslen:3189 2235ms
Mon Sep 10 03:41:34 [conn13865] profile: warning ns professor.system.profile does not exist
Mon Sep 10 03:41:34 [conn13864] serverStatus was very slow: { after basic: 0, middle of mem: 0, after mem: 0, after connections: 0, after extra info: 0, after counters: 0, after repl: 0, after asserts: 0, after dur: 2220, at end: 2220 }
Mon Sep 10 03:41:34 [conn13864] command admin.$cmd command: { serverStatus: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:59 reslen:3189 2236ms
Mon Sep 10 03:41:34 [conn13865] command admin.$cmd command: { listDatabases: 1 } ntoreturn:1 keyUpdates:0 locks(micros) R:5 r:55 reslen:405 56ms
Mon Sep 10 03:41:35 [conn12387] insert jeraff.ListInteraction keyUpdates:0 locks(micros) w:1192938 596ms
Mon Sep 10 03:41:35 [conn13865] command jeraff.$cmd command: { dbstats: 1 } ntoreturn:1 keyUpdates:0 locks(micros) r:23454 reslen:221 23ms

Mon Sep 10 03:41:37 [DataFileSync] flushing mmaps took 21665ms  for 29 files



Mon Sep 10 03:41:43 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:57443 28ms

Mon Sep 10 03:41:45 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:1139419 573ms
Mon Sep 10 03:41:45 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:365175 182ms
Mon Sep 10 03:41:48 [conn4777] insert jeraff.userLogin keyUpdates:0 locks(micros) w:78389 39ms

Mon Sep 10 03:41:51 [conn13941] end connection 192.168.254.189:40591 (425 connections now open)
Mon Sep 10 03:41:51 [initandlisten] connection accepted from 192.168.254.189:40593 #13943 (426 connections now open)
Mon Sep 10 03:42:00 [conn13942] end connection 192.168.254.82:42950 (425 connections now open)
Mon Sep 10 03:42:00 [initandlisten] connection accepted from 192.168.254.82:42953 #13944 (426 connections now open)
Mon Sep 10 03:42:07 [slaveTracking] update local.slaves query: { _id: ObjectId('xxxxx') host: "192.168.254.82", ns: "local.oplog.rs" } update: { $set: { syncedTo: Timestamp 1347248526000|1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:107 283ms

Mon Sep 10 03:42:09 [conn13316] insert jeraff.comment keyUpdates:0 locks(micros) w:1614488 807ms
Mon Sep 10 03:42:09 [conn12466] query jeraff.invitation query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:503684 reslen:816 503ms
Mon Sep 10 03:42:10 [conn13316] insert jeraff.ListInteraction keyUpdates:0 locks(micros) w:329901 165ms

Mon Sep 10 03:42:13 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:2578417 1289ms

Mon Sep 10 03:42:13 [conn247] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697040818241541) } } cursorid:4117526832372059992 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:322 nreturned:5 reslen:105 1292ms
Mon Sep 10 03:42:13 [conn246] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697006458503287) } } cursorid:3847041547395469141 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:100 nreturned:5 reslen:1553 1292ms
Mon Sep 10 03:42:13 [conn265] getmore local.oplog.rs query: { ts: { $gte: new Date(5785697865451962377) } } cursorid:520654170520312923 ntoreturn:0 keyUpdates:0 numYields: 1 locks(micros) r:96 nreturned:5 reslen:1553 1291ms
Mon Sep 10 03:42:14 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:64131 33ms
Mon Sep 10 03:42:14 [conn11051] insert jeraff.activityStream keyUpdates:0 locks(micros) w:312522 156ms

Mon Sep 10 03:42:18 [conn4655] query jeraff.todoList query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:369075 reslen:570 369ms

Mon Sep 10 03:42:18 [conn4655] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { numComments: 2 } } idhack:1 nupdated:1 keyUpdates:0 locks(micros) w:97954 97ms
Mon Sep 10 03:42:22 [conn13943] end connection 192.168.254.189:40593 (425 connections now open)
Mon Sep 10 03:42:22 [initandlisten] connection accepted from 192.168.254.189:40596 #13945 (426 connections now open)
Mon Sep 10 03:42:24 [conn4694] query jeraff.todo query: { _id: ObjectId('xxxxx')} ntoreturn:0 idhack:1 keyUpdates:0 locks(micros) r:1087969 reslen:396 1087ms
Mon Sep 10 03:42:24 [conn4689] update jeraff.todo query: { _id: ObjectId('xxxxx')} update: { $set: { upTime: 1347248544380, isOpen: true }, $unset: { completeTime: 1 } } nscanned:1 nupdated:1 keyUpdates:0 locks(micros) w:675042 337ms
Mon Sep 10 03:42:30 [conn13944] end connection 192.168.254.82:42953 (425 connections now open)
Mon Sep 10 03:42:30 [initandlisten] connection accepted from 192.168.254.82:42955 #13946 (427 connections now open)