news.bbs.geek.nz daily logs

Oct 10 23:58:02 -- Oct 11 23:58:02

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 80829 48.3%6.5 MB 28.5%
innd 32238 19.3%5.2 MB 22.5%
inn 29602 17.7%6.4 MB 27.9%
innfeed 23125 13.8%4.6 MB 20.0%
cnfsstat 1440 0.9%250.7 KB 1.1%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 167235 100.0%22.9 MB100.0%

History cache:

ReasonCount%Count
Negative hits 271770 47.6%
Positive hits 271576 47.5%
Do not exist 27764 4.9%
Cache misses 159 0.0%
TOTAL: 4 571269 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.108 0.0%130 0.000 0.831 15.000
article cleanup00:00:00.292 0.0%28990 0.000 0.010 0.040
article logging00:00:00.781 0.0%29471 0.000 0.027 0.191
article parse00:00:00.914 0.0%75416 0.000 0.012 0.027
article write00:00:02.177 0.0%20405 0.000 0.107 2.814
artlog/artcncl00:00:00.003 0.0%122 0.000 0.025 1.000
data move00:00:00.351 0.0%546014 0.000 0.001 0.005
hisgrep/artcncl00:00:00.000 0.0%129 0.000 0.000 0.000
hishave/artcncl00:00:00.001 0.0%130 0.000 0.008 0.333
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:07.305 0.0%574539 0.001 0.013 0.862
history sync00:00:00.008 0.0%355 0.000 0.023 0.500
history write00:00:06.470 0.0%27910 0.007 0.232 13.412
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
idle23:57:53.847 99.8%566278 97.546 152.352 415.120
nntp read00:00:03.308 0.0%568458 0.003 0.006 0.015
overview write00:00:35.218 0.0%20405 0.057 1.726 43.183
perl filter00:00:57.261 0.1%27910 1.367 2.052 4.722
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:01.539 0.0%40810 0.007 0.038 0.118
TOTAL: 24:00:50.26323:59:49.583 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.081 0.0%26690 0.000 0.003 0.021
article prepare00:00:00.002 0.0%11212 0.000 0.000 0.007
article read00:00:00.235 0.0%2601 0.000 0.090 3.478
backlog stats00:00:00.310 0.0%326250 0.000 0.001 0.005
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.586 0.0%272757 0.001 0.006 0.014
data write00:00:02.947 0.0%257013 0.006 0.011 0.030
idle23:54:33.660 99.9%326250 170.148 263.827 663.715
status file00:00:26.181 0.0%1845 0.667 14.190 576.800
TOTAL: 23:55:21.51323:55:05.002100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
hisgrep00:00:00.001 0.0%9 0.000 0.111 0.200
idle01:46:58.147 65.2%92793 0.000 69.166 75138.250
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:01:51.664 1.1%305604 0.000 0.365 3.583
readart00:00:03.925 0.0%14712 0.000 0.267 42.000
TOTAL: 02:43:57.15601:48:53.737 66.4%----

Control commands to INND:

CommandNumber
L 1
flush 4
flushlogs 2
go 2
logmode 2
mode 148
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 169

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1news.snarked.org 54 20111 6134 13141 836 30%53:31:46
2news-out.mixmin.net 22 21815 4643 16015 1157 21%30:55:25
3newsfeed.datemas.de 3 22714 2712 19316 686 11%25:45:38
4feeder.eternal-september.org 80 26283 2178 22927 1178 8%51:15:10
5newsfeed.neva.ru 154 20440 1350 15883 3207 6%83:07:26
6news.redatomik.org 1 20730 1053 19594 83 5%25:37:23
7news-out.aioe.org 3 25311 993 24210 108 3%32:05:16
8csiph.com 2 19877 634 19193 50 3%24:08:59
9news.albasani.net 2 25713 538 24761 414 2%28:19:50
10news.swapon.de 3 1957 181 1767 9 9%25:42:15
11agency-nz-out.news.mb-net.net 21 23146 108 22908 130 0%33:00:11
12feeder.awxg.com 2 17677 86 17543 48 0%23:59:50
13news.samoylyk.net 1 32449 84 31596 769 0%31:13:48
14news.freedyn.net 2 23226 54 23089 83 0%23:59:40
15localhost 2 1 1 0 0 100%00:00:00
TOTAL: 15 352 301450 20749 271943 8758 6%492:42:37
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.snarked.org22.0 MB273.4 KB3.2 MB25.5 MB 86%3.8 KB
2newsfeed.datemas.de11.9 MB293.4 KB2.1 MB14.3 MB 83%4.3 KB
3news-out.mixmin.net11.0 MB189.7 KB2.4 MB13.6 MB 80%2.4 KB
4feeder.eternal-september.org8.2 MB478.9 KB4.9 MB13.5 MB 60%4.1 KB
5news.albasani.net3.7 MB300.0 KB978.9 KB5.0 MB 74%5.3 KB
6newsfeed.neva.ru3.1 MB376.5 KB16.4 MB19.8 MB 15%4.5 KB
7news.redatomik.org2.5 MB237.2 KB242.8 KB3.0 MB 84%2.7 KB
8news-out.aioe.org2.3 MB204.4 KB310.2 KB2.8 MB 81%2.6 KB
9csiph.com1.7 MB177.9 KB183.0 KB2.1 MB 82%3.1 KB
10news.swapon.de439.7 KB16.7 KB18.9 KB475.3 KB 92%2.5 KB
11news.samoylyk.net373.4 KB404.4 KB9.5 MB10.3 MB 3%12.3 KB
12agency-nz-out.news.mb-net.net290.9 KB212.3 KB443.3 KB946.5 KB 30%4.0 KB
13feeder.awxg.com258.7 KB184.0 KB184.8 KB627.5 KB 41%4.7 KB
14news.freedyn.net151.9 KB199.0 KB257.5 KB608.3 KB 24%4.4 KB
15localhost1.2 KB0.0 KB0.0 KB1.2 KB100%1.2 KB
TOTAL: 1567.8 MB3.5 MB41.1 MB112.4 MB 60%3.9 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Oct 10 23:58:02 - 23:59:59 24 0.1% 0.2050.1 KB 0.1% 0.42
Oct 11 00:00:00 - 00:59:59 917 4.5% 0.252.7 MB 4.1% 0.78
Oct 11 01:00:00 - 01:59:59 922 4.5% 0.262.4 MB 3.6% 0.68
Oct 11 02:00:00 - 02:59:59 1033 5.1% 0.293.3 MB 5.0% 0.94
Oct 11 03:00:00 - 03:59:59 1175 5.8% 0.333.4 MB 5.1% 0.97
Oct 11 04:00:00 - 04:59:59 1237 6.1% 0.344.0 MB 6.0% 1.15
Oct 11 05:00:00 - 05:59:59 1178 5.8% 0.333.2 MB 4.7% 0.90
Oct 11 06:00:00 - 06:59:59 1081 5.3% 0.304.1 MB 6.2% 1.17
Oct 11 07:00:00 - 07:59:59 1096 5.4% 0.305.5 MB 8.2% 1.56
Oct 11 08:00:00 - 08:59:59 1091 5.3% 0.303.0 MB 4.5% 0.86
Oct 11 09:00:00 - 09:59:59 1061 5.2% 0.293.9 MB 5.8% 1.11
Oct 11 10:00:00 - 10:59:59 1008 4.9% 0.282.9 MB 4.3% 0.83
Oct 11 11:00:00 - 11:59:59 857 4.2% 0.242.9 MB 4.4% 0.83
Oct 11 12:00:00 - 12:59:59 696 3.4% 0.191.9 MB 2.8% 0.53
Oct 11 13:00:00 - 13:59:59 548 2.7% 0.152.2 MB 3.3% 0.64
Oct 11 14:00:00 - 14:59:59 503 2.5% 0.142.0 MB 3.0% 0.57
Oct 11 15:00:00 - 15:59:59 456 2.2% 0.132.4 MB 3.5% 0.67
Oct 11 16:00:00 - 16:59:59 459 2.2% 0.131.3 MB 2.0% 0.38
Oct 11 17:00:00 - 17:59:59 453 2.2% 0.131.5 MB 2.2% 0.42
Oct 11 18:00:00 - 18:59:59 468 2.3% 0.132.0 MB 2.9% 0.56
Oct 11 19:00:00 - 19:59:59 517 2.5% 0.142.1 MB 3.1% 0.59
Oct 11 20:00:00 - 20:59:59 887 4.3% 0.252.2 MB 3.3% 0.64
Oct 11 21:00:00 - 21:59:59 855 4.2% 0.242.8 MB 4.2% 0.80
Oct 11 22:00:00 - 22:59:59 978 4.8% 0.272.9 MB 4.3% 0.82
Oct 11 23:00:00 - 23:58:02 908 4.4% 0.262.3 MB 3.4% 0.66
TOTAL: 24:00:00 20408 100.0% 0.2467.0 MB 100.0% 0.79
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
BUFF01BIG850.0 GB20.7 GB 41.4% 0 0.32 1878.63
BUFF02BIG850.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF03ALT50.0 GB23.9 GB 47.8% 0 0.38 1577.98
BUFF04ALT50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF05BIN50.0 GB255.7 MB 0.5% 0 0.0224737.88
BUFF06BIN50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF07BIN50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF08CTCALL50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF09CTCALL50.0 GB1.6 MB 0.0% 1 0.00 0.00
BUFF10CTCALL50.0 GB9.8 GB 19.5% 0 0.62 974.18
TOTAL: 10-500.0 GB54.6 GB 10.9% 1 0.43-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.neva.ru 3243 106 0 77 3 0 0 0 3057
2news-out.mixmin.net 1425 0 0 82 0 0 0 0 1343
3feeder.eternal-september.org 1173 0 0 146 0 0 0 0 1027
4news.snarked.org 842 92 0 89 0 0 0 0 661
5newsfeed.datemas.de 757 229 0 95 0 0 0 0 433
6news.samoylyk.net 651 0 0 108 0 0 0 0 543
7news.albasani.net 378 9 0 93 0 0 0 0 276
8agency-nz-out.news.mb-net.net 137 31 0 69 0 0 0 0 37
9news.redatomik.org 118 0 0 74 0 0 0 0 44
10news-out.aioe.org 101 30 0 56 0 0 0 0 15
11news.freedyn.net 88 0 0 66 0 0 0 0 22
12feeder.awxg.com 66 2 0 64 0 0 0 0 0
13csiph.com 52 0 0 49 0 0 0 0 3
14news.swapon.de 41 0 0 8 0 0 0 0 33
15news.ausics.org 2 0 0 2 0 0 0 0 0
TOTAL: 15 9074 499 0 1078 3 0 0 0 7494

Unwanted newsgroups [Top 20]:

NewsgroupCount
ut.test 93
mpc.lists.freebsd.ports.bugs 53
gmane.linux.alsa.devel 48
it.annunci.commerciali 37
it.annunci.immobiliari 35
it.annunci.varie 33
mozilla.dev.l10n.sr 22
gmane.linux.usb.general 18
mpc.lists.freebsd.x11 17
ab.test 15
gmane.comp.gis.openstreetmap.tagging 12
mpc.lists.nanog 12
gmane.comp.handhelds.openmoko.community 11
mozilla.dev.platform 11
gmane.linux.kernel 6
mozilla.dev.ui-alerts 6
alt.sex.phone.alt.sex.phone.ads 5
mozilla.support.seamonkey 4
eagle.support.eng 4
mozilla.dev.security.policy 4
TOTAL: 55 499

Supposedly-moderated groups with unmoderated postings [Top 20]:

GroupsCount
it.scienza.astronomia 3
TOTAL: 1 3

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 6027
EMP (phn path) 536
EMP (phn nph) 271
Too many newsgroups 65
EMP (phl) 50
Too many newsgroups (low_xpost) 18
Binary: misplaced par2 14
User-issued cancel 10
Binary: non-binary distribution 6
HTML post 3
Binary: misplaced 002 2
Binary: misplaced 053 1
Binary: misplaced com 1
Binary: misplaced sfv 1
Binary: misplaced 024 1
Too many newsgroups (meow) 1
Binary Image: misplaced png 1
Binary: misplaced 023 1
TOTAL: 18 7009

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
news-out.mixmin.net 273
newsfeed.datemas.de 94
news.redatomik.org 43
news.swapon.de 32
news.albasani.net 26
news.snarked.org 6
news-out.aioe.org 5
newsfeed.neva.ru 4
agency-nz-out.news.mb-net.net 1
news.samoylyk.net 1
TOTAL: 10 485
TOTAL: 1 485

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.ausics.org 18437 1536 16847 54 0 0 8%23:59:47
2awxg 19935 82 19810 6 0 10 0%23:59:45
3news.freedyn.net 20694 14 20343 3 0 34 0%23:59:46
4news.snarked.org 14097 3 13942 13 0 14 0%23:59:45
5news.redatomik.org 19464 3 19428 1 0 0 0%23:59:46
6news.albasani.net 21100 2 18140 978 0 6219 0%23:59:46
7aioe 17869 1 17770 0 0 0 0%23:59:42
8news.samoylyk.net 18427 1 18366 0 0 0 0%23:59:46
9eternal-september 17519 1 17418 0 0 92 0%23:59:43
10mb-net.net 20326 1 20272 0 0 0 0%23:59:33
11neva.ru 18608 1 18597 0 0 41 0%23:59:46
12news-in.mixmin.net 15136 1 15129 0 0 0 0%23:59:46
13newsfeed.datemas.de 17803 1 17777 0 0 0 0%23:59:46
14csiph.com 19799 1 19732 0 0 0 0%23:59:47
15news.swapon.de 1752 0 1751 0 0 0 0%23:54:32
TOTAL: 15 260966 1648 255322 1055 0 6410 0%359:50:56
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.ausics.org14.9 MB2.5 MB17.4 MB0.2 KB/s11.2 KB23:59:47
2awxg425.2 KB37.0 KB462.2 KB0.0 KB/s5.3 KB23:59:45
3news.freedyn.net36.1 KB4.5 KB40.6 KB0.0 KB/s2.4 KB23:59:46
4news.redatomik.org5.5 KB2.9 KB8.4 KB0.0 KB/s2.1 KB23:59:46
5news.snarked.org4.7 KB20.8 KB25.5 KB0.0 KB/s1.6 KB23:59:45
6news.albasani.net2.5 KB3.0 MB3.0 MB0.0 KB/s3.2 KB23:59:46
7aioe1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:42
8news.samoylyk.net1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:46
9eternal-september1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:43
10mb-net.net1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:33
11neva.ru1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:46
12news-in.mixmin.net1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:46
13newsfeed.datemas.de1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:46
14csiph.com1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB23:59:47
15news.swapon.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:54:32
TOTAL: 1515.4 MB5.6 MB20.9 MB0.0 KB/s7.9 KB359:50:56
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1agency.bbs.geek.nz 297 612820.8 MB 2831 1 000:09:20
267-61-21-181.cpe.cableone.net 2 588220.7 MB 459 0 401:09:19
3163.47.16.169 24 10721.6 MB 137 0 000:04:52
460.234.244.55 5 1731.3 KB 1 0 000:25:28
567-60-219-146.cpe.cableone.net 1 00.0 KB 2 0 000:00:00
TOTAL: 5 329 1309943.2 MB 3430 1 402:59:39

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.bbs.geek.nz 297 612820.8 MB 2831 1 000:09:20
2*.cpe.cableone.net 3 588220.7 MB 461 0 401:09:19
3unresolved 38 10891.6 MB 138 0 001:40:56
TOTAL: 3 338 1309943.2 MB 3430 1 402:59:39

NNRP auth users [Top 20]:

UserConn
amybbs 24
crash 5
bpanther 2
malcolmlewis 1
TOTAL: 4 32

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
67-61-21-181.cpe.cableone.net 0.588 0.728 0.03601:09:19
118.149.180.160 0.248 0.020 0.00000:41:49
118.149.158.160 1.072 0.084 0.00000:28:45
60.234.244.55 0.376 0.060 0.01500:25:28
agency.bbs.geek.nz 20.908 4.756 0.00000:09:20
163.47.16.169 1.384 0.388 0.22600:04:52
? 1.408 0.176 0.00000:00:02
TOTAL: 7 25.984 6.212 0.27702:59:39

Curious NNRP server explorers [Top 20]:

SystemConn
118.149.158.160 6
118.149.180.160 3
TOTAL: 2 9

NNRP gethostbyaddr failures [Top 20]:

SystemConn
? (can't getpeername) 16
TOTAL: 1 16

NNRP unrecognized commands (by host):

SystemConn
60.234.244.55 1
TOTAL: 1 1

NNRP unrecognized commands (by command):

CommandCount
XFEATURE COMPRESS GZIP TERMINATOR 1
TOTAL: 1 1

NNRP client timeouts [Top 20]:

SystemConnPeer
118.149.180.160 1 1
agency.bbs.geek.nz 1 1
TOTAL: 2 2 2

Newsgroup request counts (by category):

CategoryCountPct
1rec 5978 45.7%
2comp 1792 13.7%
3soc 1755 13.4%
4sci 1547 11.8%
5alt 956 7.3%
6talk 602 4.6%
7news 151 1.2%
8misc 110 0.8%
9uk 57 0.4%
10humanities 45 0.3%
11nz 41 0.3%
12mozilla 38 0.3%
13aus 9 0.1%
14agency 8 0.1%
15eternal-september 3 0.0%
TOTAL: 15 13092100.0%

Newsgroup request counts (by newsgroup) [Top 100]:

NewsgroupCount
1rec.arts.tv 1644
2rec.food.cooking 486
3rec.sport.soccer 433
4sci.physics.relativity 426
5alt.atheism 411
6rec.arts.drwho 372
7soc.retirement 367
8rec.sport.tennis 345
9talk.politics.guns 306
10sci.physics 294
11soc.culture.polish 280
12comp.lang.c 257
13sci.math 256
14rec.sport.football.college 246
15soc.culture.israel 238
16comp.lang.python 233
17rec.gambling.poker 229
18alt.comp.os.windows-10 197
19rec.arts.sf.written 176
20talk.origins 170
21rec.boats 164
22rec.sport.pro-wrestling 157
23rec.sport.golf 144
24comp.lang.c++ 142
25rec.bicycles.tech 140
26sci.electronics.design 140
27soc.culture.indian 136
28news.lists.filters 129
29comp.sys.mac.system 110
30sci.med.pharmacy 107
31soc.culture.usa 100
32comp.sys.mac.advocacy 100
33sci.logic 91
34comp.os.vms 90
35rec.photo.digital 87
36talk.politics.misc 86
37comp.os.linux.misc 81
38comp.sys.apple2 74
39soc.culture.china 72
40alt.test 71
41rec.arts.movies.current-films 69
42soc.history.medieval 68
43alt.politics 66
44rec.games.trivia 64
45rec.sport.cricket 63
46comp.lang.forth 60
47comp.mobile.android 60
48rec.crafts.metalworking 56
49soc.culture.bulgaria 54
50rec.aviation.soaring 53
51comp.os.linux.advocacy 52
52sci.astro.amateur 50
53rec.audio.pro 49
54soc.culture.brazil 49
55humanities.lit.authors.shakespeare 45
56alt.astronomy 43
57rec.games.pinball 41
58rec.music.classical.recordings 41
59rec.music.rock-pop-r+b.1950s 41
60soc.history.what-if 38
61rec.games.video.sony 37
62soc.culture.vietnamese 37
63alt.recovery.aa 36
64sci.military.naval 36
65rec.music.dylan 35
66rec.skiing.alpine 35
67misc.survivalism 34
68alt.bible 33
69rec.music.classical.guitar 32
70comp.soft-sys.sas 32
71rec.arts.sf.fandom 32
72nz.general 32
73comp.lang.fortran 31
74comp.protocols.time.ntp 31
75uk.radio.amateur 30
76sci.lang 28
77soc.culture.europe 28
78mozilla.support.firefox 28
79rec.arts.movies.past-films 28
80alt.os.linux.ubuntu 27
81comp.unix.programmer 27
82soc.women 26
83rec.arts.comics.strips 26
84misc.phone.mobile.iphone 24
85rec.outdoors.rv-travel 24
86comp.os.cpm 24
87comp.lang.lisp 24
88comp.sys.acorn.apps 23
89talk.bizarre 23
90rec.gambling.lottery 23
91soc.culture.african.american 23
92rec.radio.amateur.misc 23
93rec.radio.shortwave 23
94soc.genealogy.medieval 22
95rec.music.beatles 22
96rec.music.rock-pop-r+b.1960s 22
97comp.sys.apple2.programmer 21
98rec.pets.cats.community 21
99rec.aquaria.marine.misc 20
100soc.genealogy.benelux 19
TOTAL: 340 13092