news.bbs.geek.nz daily logs

Jan 16 23:58:02 -- Jan 17 23:58:01

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 151902 64.0%12.5 MB 43.4%
innd 31606 13.3%5.1 MB 17.7%
inn 29261 12.3%6.4 MB 22.3%
innfeed 23253 9.8%4.6 MB 15.8%
cnfsstat 1440 0.6%253.2 KB 0.9%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 237463 100.0%28.9 MB100.0%

History cache:

ReasonCount%Count
Negative hits 273391 48.7%
Positive hits 260382 46.4%
Do not exist 27497 4.9%
Cache misses 159 0.0%
TOTAL: 4 561429 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.139 0.0%92 0.000 1.511 16.000
article cleanup00:00:00.256 0.0%28347 0.000 0.009 0.030
article logging00:00:00.691 0.0%29002 0.000 0.024 0.072
article parse00:00:00.853 0.0%66710 0.000 0.013 0.027
article write00:00:01.624 0.0%20518 0.000 0.079 0.431
artlog/artcncl00:00:00.003 0.0%86 0.000 0.035 1.000
data move00:00:00.362 0.0%530478 0.000 0.001 0.015
hisgrep/artcncl00:00:00.001 0.0%80 0.000 0.013 1.000
hishave/artcncl00:00:00.000 0.0%92 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:09.935 0.0%562428 0.000 0.018 1.199
history sync00:00:00.020 0.0%355 0.000 0.056 1.000
history write00:00:07.559 0.0%27525 0.012 0.275 18.387
hiswrite/artcncl00:00:00.000 0.0%12 0.000 0.000 0.000
idle23:47:16.182 99.8%547886 95.088 156.303 400.213
nntp read00:00:03.411 0.0%548925 0.002 0.006 0.020
overview write00:00:52.026 0.1%20518 0.065 2.536 136.406
perl filter00:00:56.335 0.1%27525 1.340 2.047 28.495
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:01.412 0.0%41036 0.011 0.034 0.095
TOTAL: 23:50:42.19723:49:30.809 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.084 0.0%28076 0.000 0.003 0.021
article prepare00:00:00.001 0.0%9528 0.000 0.000 0.009
article read00:00:00.206 0.0%2156 0.000 0.096 3.000
backlog stats00:00:00.294 0.0%330932 0.000 0.001 0.003
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.635 0.0%276555 0.002 0.006 0.011
data write00:00:03.017 0.0%259824 0.006 0.012 0.026
idle23:53:23.558100.0%330932 161.210 259.883 607.360
status file00:00:14.077 0.0%1898 0.786 7.417 322.562
TOTAL: 23:54:00.06923:53:42.872100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
hisgrep00:00:00.002 0.0%24 0.000 0.083 0.400
idle42:31:11.955 99.4%170635 0.000 897.072 86351.905
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:34.237 0.0%379261 0.000 0.090 1.522
readart00:00:12.501 0.0%17995 0.000 0.695 18.333
TOTAL: 42:46:56.78342:31:58.695 99.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 34 18223 6043 11910 270 33%39:48:25
2news-out.mixmin.net 13 21841 4344 16411 1086 19%28:28:35
3news-out.aioe.org 4 20366 2816 17388 162 13%25:21:01
4feeder.eternal-september.org 66 26358 2048 22756 1554 7%47:08:18
5news.albasani.net 2 24268 1670 22005 593 6%27:57:36
6newsfeed.neva.ru 150 17717 1223 12980 3514 6%84:00:51
7csiph.com 2 23998 1117 22836 45 4%30:19:26
8newsfeed.datemas.de 2 19478 679 18485 314 3%21:41:01
9news.redatomik.org 1 15859 247 15548 64 1%18:26:30
10news.swapon.de 5 1875 241 1628 6 12%26:06:44
11feeder.awxg.com 3 18011 130 17827 54 0%24:02:26
12news.samoylyk.net 4 22176 90 22024 62 0%28:35:32
13agency-nz-out.news.mb-net.net 14 22990 84 22780 126 0%29:11:56
14news.freedyn.net 1 19717 33 19649 35 0%18:38:29
15news.ausics.org 4 19374 3 19367 4 0%29:59:04
16localhost 3 2 2 0 0 100%00:00:00
TOTAL: 16 308 292253 20770 263594 7889 7%479:45:54
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.snarked.org21.4 MB199.7 KB985.1 KB22.5 MB 94%3.7 KB
2news-out.mixmin.net12.7 MB464.3 KB2.4 MB15.5 MB 81%2.9 KB
3news.albasani.net6.8 MB403.2 KB1.5 MB8.7 MB 77%4.0 KB
4news-out.aioe.org6.7 MB191.0 KB394.3 KB7.3 MB 92%2.5 KB
5feeder.eternal-september.org6.2 MB605.0 KB6.2 MB13.0 MB 47%3.7 KB
6newsfeed.datemas.de4.8 MB246.0 KB1.7 MB6.7 MB 71%6.9 KB
7csiph.com3.1 MB166.6 KB180.8 KB3.4 MB 90%3.0 KB
8newsfeed.neva.ru2.9 MB148.0 KB10.6 MB13.6 MB 21%2.9 KB
9news.redatomik.org707.8 KB253.7 KB260.8 KB1.2 MB 57%3.9 KB
10news.swapon.de688.3 KB99.8 KB196.0 KB984.2 KB 69%4.0 KB
11agency-nz-out.news.mb-net.net406.5 KB308.0 KB663.4 KB1.3 MB 29%6.6 KB
12feeder.awxg.com377.6 KB154.2 KB167.6 KB699.3 KB 53%3.8 KB
13news.freedyn.net374.9 KB227.2 KB272.2 KB874.3 KB 42%12.9 KB
14news.samoylyk.net238.0 KB465.7 KB465.7 KB1.1 MB 20%7.7 KB
15news.ausics.org8.8 KB6.3 KB8.4 KB23.6 KB 37%3.4 KB
16localhost6.3 KB0.0 KB0.0 KB6.3 KB100%3.2 KB
TOTAL: 1667.3 MB3.8 MB25.8 MB97.0 MB 69%3.5 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Jan 16 23:58:02 - 23:59:59 23 0.1% 0.1956.4 KB 0.1% 0.48
Jan 17 00:00:00 - 00:59:59 1013 4.9% 0.282.7 MB 4.0% 0.75
Jan 17 01:00:00 - 01:59:59 889 4.3% 0.253.2 MB 4.8% 0.90
Jan 17 02:00:00 - 02:59:59 977 4.7% 0.272.8 MB 4.2% 0.80
Jan 17 03:00:00 - 03:59:59 1107 5.4% 0.313.8 MB 5.7% 1.07
Jan 17 04:00:00 - 04:59:59 1258 6.1% 0.353.6 MB 5.5% 1.03
Jan 17 05:00:00 - 05:59:59 1279 6.2% 0.363.3 MB 4.9% 0.93
Jan 17 06:00:00 - 06:59:59 1201 5.8% 0.333.1 MB 4.6% 0.87
Jan 17 07:00:00 - 07:59:59 1200 5.8% 0.333.6 MB 5.4% 1.01
Jan 17 08:00:00 - 08:59:59 1279 6.2% 0.365.9 MB 8.8% 1.66
Jan 17 09:00:00 - 09:59:59 1089 5.3% 0.303.4 MB 5.2% 0.97
Jan 17 10:00:00 - 10:59:59 1123 5.4% 0.314.0 MB 6.1% 1.15
Jan 17 11:00:00 - 11:59:59 952 4.6% 0.263.9 MB 5.8% 1.10
Jan 17 12:00:00 - 12:59:59 691 3.3% 0.192.8 MB 4.2% 0.79
Jan 17 13:00:00 - 13:59:59 530 2.6% 0.151.5 MB 2.2% 0.42
Jan 17 14:00:00 - 14:59:59 456 2.2% 0.131.3 MB 2.0% 0.38
Jan 17 15:00:00 - 15:59:59 514 2.5% 0.141.7 MB 2.6% 0.50
Jan 17 16:00:00 - 16:59:59 490 2.4% 0.141.7 MB 2.6% 0.49
Jan 17 17:00:00 - 17:59:59 414 2.0% 0.121.5 MB 2.2% 0.42
Jan 17 18:00:00 - 18:59:59 450 2.2% 0.121.4 MB 2.2% 0.41
Jan 17 19:00:00 - 19:59:59 513 2.5% 0.141.6 MB 2.4% 0.45
Jan 17 20:00:00 - 20:59:59 575 2.8% 0.162.2 MB 3.3% 0.62
Jan 17 21:00:00 - 21:59:59 796 3.9% 0.222.4 MB 3.6% 0.68
Jan 17 22:00:00 - 22:59:59 909 4.4% 0.252.4 MB 3.7% 0.70
Jan 17 23:00:00 - 23:58:01 928 4.5% 0.272.7 MB 4.1% 0.79
TOTAL: 23:59:59 20656 100.0% 0.2466.4 MB 100.0% 0.79
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
BUFF01BIG850.0 GB23.0 GB 45.9% 0 0.32 1910.66
BUFF02BIG850.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF03ALT50.0 GB26.6 GB 53.3% 0 0.33 1865.69
BUFF04ALT50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF05BIN50.0 GB286.0 MB 0.6% 0 0.0318436.21
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 GB15.1 GB 30.3% 0 0.68 889.57
TOTAL: 10-500.0 GB65.0 GB 13.0% 1 0.43-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.neva.ru 3514 54 0 49 0 0 0 0 3411
2feeder.eternal-september.org 1560 0 0 108 0 0 0 0 1452
3news-out.mixmin.net 1478 0 0 130 0 0 0 0 1348
4news.albasani.net 653 12 0 63 0 0 0 0 578
5newsfeed.datemas.de 370 160 0 54 0 0 0 0 156
6news.snarked.org 269 29 0 58 0 0 0 0 182
7news-out.aioe.org 190 7 0 59 0 0 0 0 124
8agency-nz-out.news.mb-net.net 126 26 0 62 0 0 0 0 38
9news.redatomik.org 95 0 0 76 0 0 0 0 19
10news.swapon.de 76 0 0 2 0 0 0 0 74
11feeder.awxg.com 57 5 0 50 0 0 0 0 2
12news.samoylyk.net 55 0 0 55 0 0 0 0 0
13news.freedyn.net 38 2 0 25 0 0 0 0 11
14csiph.com 36 0 0 35 0 0 0 0 1
15news.ausics.org 2 0 0 2 0 0 0 0 0
TOTAL: 15 8519 295 0 828 0 0 0 0 7396

Unwanted newsgroups [Top 20]:

NewsgroupCount
it.annunci.commerciali 37
gmane.linux.alsa.devel 35
it.annunci.immobiliari 34
gmane.comp.gis.openstreetmap.tagging 32
it.annunci.varie 28
mozilla.dev.platform 16
gmane.linux.kernel 14
mozilla.dev.security.policy 12
mpc.lists.freebsd.gecko 8
mozilla.support.seamonkey 8
att.jobs 7
aus.jobs 6
al.christnet.bible 4
mozilla.dev.ui-alerts 4
mpc.lists.freebsd.office 3
south-wales.test 3
talk.wieslauf.points 3
mozilla.dev.tech.js-engine 2
alt.ufo 2
mpc.lists.freebsd.gnome 2
TOTAL: 50 295

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 5835
EMP (phn path) 389
EMP (phn nph) 298
Too many newsgroups 83
EMP (phl) 66
HTML post 22
User-issued cancel 21
Binary: non-binary distribution 6
Binary: misplaced par2 5
Binary Image: misplaced png 4
HTML Multipart without Text/Plain. 1
Binary: misplaced 666 1
Binary: misplaced txt 1
Binary Image: misplaced gif 1
Binary: misplaced 012 1
TOTAL: 15 6734

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
news-out.mixmin.net 373
news.albasani.net 140
news.swapon.de 72
news-out.aioe.org 35
newsfeed.datemas.de 20
news.redatomik.org 12
newsfeed.neva.ru 7
feeder.awxg.com 1
news.snarked.org 1
feeder.eternal-september.org 1
TOTAL: 10 662
TOTAL: 1 662

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.ausics.org 19134 953 18077 44 0 208 4%23:59:47
2awxg 20180 133 20031 6 0 11 0%23:59:45
3news.freedyn.net 20927 16 20612 0 0 5 0%23:59:43
4aioe 16811 5 16667 0 0 0 0%23:59:43
5mb-net.net 20602 4 20540 0 0 0 0%23:59:47
6news.samoylyk.net 19047 3 18989 2 0 361 0%23:59:46
7news.redatomik.org 20406 3 20280 0 0 227 0%23:59:47
8news-in.mixmin.net 15300 2 15276 0 0 0 0%23:59:37
9neva.ru 18951 2 18940 0 0 0 0%23:59:47
10news.snarked.org 14422 2 14406 0 0 0 0%23:59:47
11csiph.com 19762 2 19663 0 0 6 0%23:59:47
12eternal-september 17778 1 17740 0 0 64 0%23:59:47
13newsfeed.datemas.de 19990 0 19872 0 0 124 0%23:59:47
14news.albasani.net 20237 0 17255 1101 0 6594 0%23:59:47
15news.swapon.de 1578 0 1576 0 0 0 0%23:50:09
TOTAL: 15 265125 1126 259924 1153 0 7600 0%359:46:46
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.ausics.org9.7 MB443.1 KB10.1 MB0.1 KB/s10.4 KB23:59:47
2awxg467.0 KB29.6 KB496.6 KB0.0 KB/s3.6 KB23:59:45
3news.freedyn.net52.0 KB0.0 KB52.0 KB0.0 KB/s3.2 KB23:59:43
4news.redatomik.org32.2 KB0.0 KB32.2 KB0.0 KB/s10.7 KB23:59:47
5aioe18.9 KB0.0 KB18.9 KB0.0 KB/s3.8 KB23:59:43
6mb-net.net13.6 KB0.0 KB13.6 KB0.0 KB/s3.4 KB23:59:47
7news.samoylyk.net7.7 KB43.2 KB50.9 KB0.0 KB/s10.2 KB23:59:46
8news-in.mixmin.net6.3 KB0.0 KB6.3 KB0.0 KB/s3.2 KB23:59:37
9neva.ru6.3 KB0.0 KB6.3 KB0.0 KB/s3.2 KB23:59:47
10news.snarked.org6.3 KB0.0 KB6.3 KB0.0 KB/s3.2 KB23:59:47
11csiph.com6.3 KB0.0 KB6.3 KB0.0 KB/s3.2 KB23:59:47
12eternal-september3.6 KB0.0 KB3.6 KB0.0 KB/s3.6 KB23:59:47
13newsfeed.datemas.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:47
14news.albasani.net0.0 KB3.6 MB3.6 MB0.0 KB/s3.4 KB23:59:47
15news.swapon.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:50:09
TOTAL: 1510.3 MB4.1 MB14.4 MB0.0 KB/s6.5 KB359:46:46
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
167-61-21-181.cpe.cableone.net 9 828928.5 MB 1225 0 1602:45:23
2agency.bbs.geek.nz 385 739724.7 MB 4348 0 000:14:24
3vorlon.activateit.net.au 24 10671.4 MB 138 0 000:05:05
4192.168.1.9 1 2722.1 MB 12 0 000:00:12
560.234.68.122 14 4697.2 KB 3 0 000:46:06
667-60-219-146.cpe.cableone.net 4 921.9 KB 6 2 038:42:02
TOTAL: 6 437 1708056.8 MB 5732 2 1642:46:49

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.cpe.cableone.net 13 829828.5 MB 1231 2 1641:27:26
2*.bbs.geek.nz 385 739724.7 MB 4348 0 000:14:24
3*.activateit.net.au 24 10671.4 MB 138 0 000:05:05
4unresolved 22 3182.2 MB 15 0 000:59:51
TOTAL: 4 444 1708056.8 MB 5732 2 1642:46:49

NNRP auth users [Top 20]:

UserConn
amybbs 24
crash 9
bpanther 8
malcolmlewis 4
paulh 1
TOTAL: 5 46

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
67-60-219-146.cpe.cableone.net 0.460 0.120 0.01538:42:02
67-61-21-181.cpe.cableone.net 1.776 1.268 0.10602:45:23
60.234.68.122 0.920 0.144 0.02700:46:06
agency.bbs.geek.nz 29.156 7.120 0.00000:14:24
118.149.221.40 0.128 0.008 0.00000:07:45
118.149.228.239 0.244 0.024 0.00000:05:37
vorlon.activateit.net.au 1.376 0.372 0.17800:05:05
192.168.1.9 0.152 0.036 0.00300:00:12
104.131.149.222 0.056 0.004 0.00000:00:09
? 1.072 0.144 0.00000:00:01
TOTAL: 10 35.340 9.240 0.32942:46:49

Curious NNRP server explorers [Top 20]:

SystemConn
118.149.228.239 4
118.149.221.40 2
104.131.149.222 1
TOTAL: 3 7

NNRP gethostbyaddr failures [Top 20]:

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

NNRP unrecognized commands (by host):

SystemConn
60.234.68.122 3
TOTAL: 1 3

NNRP unrecognized commands (by command):

CommandCount
XFEATURE COMPRESS GZIP TERMINATOR 3
TOTAL: 1 3

NNRP client timeouts [Top 20]:

SystemConnPeer
67-61-21-181.cpe.cableone.net 1 0
TOTAL: 1 1 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 5749 33.7%
2alt 2076 12.2%
3sci 1820 10.7%
4comp 1774 10.4%
5soc 1744 10.2%
6uk 1327 7.8%
7linux 915 5.4%
8talk 729 4.3%
9misc 334 2.0%
10news 239 1.4%
11nz 167 1.0%
12mozilla 90 0.5%
13microsoft 31 0.2%
14agency 27 0.2%
15perl 14 0.1%
16aus 9 0.1%
17humanities 8 0.0%
18newsguy 6 0.0%
19eternal-september 1 0.0%
TOTAL: 19 17060100.0%

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

NewsgroupCount
1rec.arts.tv 1221
2rec.food.cooking 613
3rec.arts.sf.written 569
4alt.fan.rush-limbaugh 469
5uk.d-i-y 451
6rec.arts.drwho 443
7uk.legal 412
8sci.physics 402
9comp.lang.python 334
10linux.debian.bugs.dist 333
11alt.atheism 269
12talk.politics.misc 256
13talk.politics.guns 249
14rec.sport.tennis 248
15rec.gambling.poker 246
16alt.comp.os.windows-10 244
17rec.sport.football.college 230
18sci.electronics.design 228
19alt.politics.trump 221
20sci.logic 221
21talk.origins 210
22misc.survivalism 202
23sci.physics.relativity 200
24sci.math 192
25rec.boats 191
26soc.retirement 184
27soc.culture.polish 184
28news.lists.filters 174
29soc.culture.israel 165
30linux.debian.changes.devel 154
31soc.history 151
32rec.sport.golf 150
33soc.penpals 150
34soc.culture.china 149
35alt.bible.prophecy 142
36comp.os.linux.advocacy 137
37nz.general 118
38comp.sys.mac.system 114
39comp.lang.c++ 111
40rec.music.classical.recordings 107
41rec.sport.pro-wrestling 103
42comp.lang.c 103
43soc.culture.indian 102
44alt.politics 102
45comp.mobile.ipad 100
46alt.test 99
47rec.photo.digital 96
48soc.culture.singapore 95
49rec.crafts.metalworking 93
50soc.culture.bulgaria 90
51rec.aquaria.marine.misc 88
52comp.sys.apple2 87
53alt.conspiracy 87
54soc.culture.vietnamese 84
55sci.med.cardiology 84
56comp.lang.forth 81
57rec.aviation.marketplace 80
58rec.arts.sf.tv 78
59sci.electronics.repair 77
60alt.conspiracy.jfk 76
61uk.comp.sys.mac 74
62linux.debian.user 74
63soc.history.what-if 73
64uk.rec.cycling 72
65comp.sys.raspberry-pi 72
66soc.culture.usa 71
67uk.radio.amateur 69
68alt.recovery.aa 69
69sci.astro.amateur 67
70rec.woodworking 66
71comp.protocols.time.ntp 64
72rec.radio.shortwave 61
73rec.aviation.soaring 61
74comp.mobile.android 60
75mozilla.support.thunderbird 59
76sci.math.num-analysis 59
77rec.outdoors.rv-travel 58
78uk.legal.moderated 57
79uk.comp.homebuilt 57
80sci.military.naval 57
81uk.tech.digital-tv 56
82rec.music.rock-pop-r+b.1950s 55
83rec.music.dylan 52
84linux.debian.user.french 52
85comp.sys.mac.advocacy 51
86alt.bible 51
87comp.lang.fortran 50
88alt.support.diabetes 49
89nz.comp 48
90linux.debian.bugs.rc 47
91misc.phone.mobile.iphone 46
92sci.lang 43
93rec.sport.soccer 42
94rec.drugs.cannabis 42
95comp.arch 41
96sci.crypt 41
97misc.invest.stocks 40
98soc.culture.brazil 40
99sci.astro 40
100rec.arts.disney.parks 38
TOTAL: 389 17060