news.bbs.nz daily logs

Oct 18 23:58:01 -- Oct 19 23:58:02

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 126502 61.0%9.8 MB 38.3%
innd 32465 15.6%5.3 MB 20.6%
innfeed 24608 11.9%4.9 MB 19.1%
inn 22456 10.8%5.3 MB 20.9%
cnfsstat 1440 0.7%258.9 KB 1.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 207472 100.0%25.5 MB100.0%

History cache:

ReasonCount%Count
Negative hits 270036 49.2%
Positive hits 257234 46.9%
Do not exist 21592 3.9%
Cache misses 149 0.0%
TOTAL: 4 549011 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.183 0.0%41 0.000 4.463 11.000
article cleanup00:00:00.245 0.0%21834 0.000 0.011 0.041
article logging00:00:00.562 0.0%22230 0.000 0.025 0.243
article parse00:00:00.692 0.0%75509 0.000 0.009 0.023
article write00:00:01.475 0.0%16861 0.000 0.087 2.151
artlog/artcncl00:00:00.000 0.0%41 0.000 0.000 0.000
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.564 0.0%535007 0.000 0.001 0.013
hisgrep/artcncl00:00:00.000 0.0%41 0.000 0.000 0.000
hishave/artcncl00:00:00.001 0.0%41 0.000 0.024 0.077
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:09.080 0.0%550837 0.002 0.016 0.914
history sync00:00:00.023 0.0%366 0.000 0.063 1.000
history write00:00:06.518 0.0%21654 0.014 0.301 19.429
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:47:44.365 99.8%545271 99.168 157.104 488.243
nntp read00:00:03.898 0.0%548071 0.003 0.007 0.017
overview write00:00:38.312 0.0%16861 0.036 2.272 52.943
perl filter00:00:39.656 0.0%21651 1.032 1.832 12.023
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:00.907 0.0%33722 0.000 0.027 0.125
TOTAL: 23:50:57.34523:49:26.481 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.052 0.0%22580 0.000 0.002 0.021
article prepare00:00:00.002 0.0%6328 0.000 0.000 0.011
article read00:00:00.922 0.0%1531 0.000 0.602 41.083
backlog stats00:00:00.520 0.0%295662 0.000 0.002 0.006
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.034 0.0%244947 0.002 0.008 0.017
data write00:00:02.758 0.0%231167 0.004 0.012 0.020
idle23:53:29.260 99.9%295662 185.318 290.904 711.553
status file00:00:29.174 0.0%1840 0.400 15.855 540.725
TOTAL: 23:54:22.84023:54:04.722100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle42:55:16.793 99.8%134197 0.000 1151.418600193.333
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:01.802 0.0%280541 0.000 0.006 0.600
readart00:00:01.472 0.0%6628 0.000 0.222 11.400
TOTAL: 43:01:14.29942:55:20.067 99.8%----

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
1bbs-nz-out.news.weretis.net 4 34932 4372 30314 246 12%48:30:24
2news.snarked.org 31 19870 2647 15675 1548 13%31:45:48
3feeder.eternal-september.org 10 20301 2346 17795 160 11%27:16:22
4bbsnz-out.feed.uzoreto.com 576 23322 2259 20448 615 9%47:25:56
5news-out.aioe.org 3 18433 1614 16783 36 8%26:04:22
6news.albasani.net 1 17650 1240 16052 358 7%23:40:11
7news-out.mixmin.net 1 16320 986 14953 381 6%21:59:01
8newsfeed.neva.ru 149 13595 916 11182 1497 6%72:35:29
9csiph.com 2 16726 161 16555 10 0%23:59:29
10news.redatomik.org 2 11900 157 11729 14 1%15:17:11
11news.swapon.de 3 1354 117 1236 1 8%24:21:40
12agency-nz-out.news.mb-net.net 5 18407 67 18312 28 0%24:44:45
13news.samoylyk.net 2 18320 65 18237 18 0%28:32:39
14news.freedyn.net 2 18514 43 18448 23 0%24:00:06
15feeder.awxg.com 1 15002 29 14966 7 0%23:59:56
16localhost 1 0 0 0 0 0%00:00:00
TOTAL: 16 793 264646 17019 242685 4942 6%464:13:19
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1bbs-nz-out.news.weretis.net18.4 MB929.0 KB1.8 MB21.0 MB 87%4.7 KB
2news.snarked.org9.0 MB89.6 KB15.7 MB24.8 MB 36%6.1 KB
3bbsnz-out.feed.uzoreto.com6.2 MB295.6 KB8.8 MB15.3 MB 40%5.4 KB
4feeder.eternal-september.org6.1 MB416.3 KB1020.6 KB7.5 MB 81%3.1 KB
5news.albasani.net4.0 MB450.9 KB982.1 KB5.4 MB 74%3.5 KB
6news-out.aioe.org4.0 MB34.5 KB227.5 KB4.2 MB 93%2.6 KB
7news-out.mixmin.net3.0 MB38.4 KB661.5 KB3.6 MB 81%2.7 KB
8newsfeed.neva.ru2.1 MB22.5 KB15.6 MB17.7 MB 11%7.5 KB
9news.redatomik.org609.8 KB432.3 KB442.7 KB1.4 MB 41%8.7 KB
10news.freedyn.net522.0 KB82.2 KB105.6 KB709.8 KB 73%10.8 KB
11csiph.com442.1 KB37.0 KB38.4 KB517.6 KB 85%3.0 KB
12news.swapon.de287.7 KB2.5 KB2.5 KB292.6 KB 98%2.5 KB
13news.samoylyk.net167.2 KB464.6 KB465.8 KB1.1 MB 15%13.2 KB
14agency-nz-out.news.mb-net.net164.7 KB104.6 KB179.3 KB448.6 KB 36%4.7 KB
15feeder.awxg.com100.6 KB84.8 KB84.8 KB270.3 KB 37%7.5 KB
16localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1655.0 MB3.4 MB45.9 MB104.3 MB 52%4.9 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Oct 18 23:58:01 - 23:59:59 24 0.1% 0.2056.6 KB 0.1% 0.48
Oct 19 00:00:00 - 00:59:59 801 4.7% 0.222.4 MB 4.4% 0.69
Oct 19 01:00:00 - 01:59:59 868 5.1% 0.242.1 MB 3.8% 0.59
Oct 19 02:00:00 - 02:59:59 985 5.8% 0.273.0 MB 5.4% 0.84
Oct 19 03:00:00 - 03:59:59 952 5.6% 0.262.5 MB 4.5% 0.71
Oct 19 04:00:00 - 04:59:59 871 5.1% 0.242.9 MB 5.4% 0.84
Oct 19 05:00:00 - 05:59:59 994 5.8% 0.282.7 MB 4.8% 0.75
Oct 19 06:00:00 - 06:59:59 966 5.7% 0.272.7 MB 4.9% 0.76
Oct 19 07:00:00 - 07:59:59 899 5.3% 0.253.8 MB 6.9% 1.08
Oct 19 08:00:00 - 08:59:59 930 5.5% 0.263.0 MB 5.4% 0.85
Oct 19 09:00:00 - 09:59:59 875 5.1% 0.243.3 MB 6.0% 0.94
Oct 19 10:00:00 - 10:59:59 633 3.7% 0.182.6 MB 4.8% 0.75
Oct 19 11:00:00 - 11:59:59 585 3.4% 0.162.4 MB 4.3% 0.68
Oct 19 12:00:00 - 12:59:59 622 3.7% 0.171.8 MB 3.3% 0.52
Oct 19 13:00:00 - 13:59:59 445 2.6% 0.121.5 MB 2.7% 0.42
Oct 19 14:00:00 - 14:59:59 341 2.0% 0.091.4 MB 2.6% 0.40
Oct 19 15:00:00 - 15:59:59 369 2.2% 0.101.3 MB 2.4% 0.38
Oct 19 16:00:00 - 16:59:59 351 2.1% 0.101.3 MB 2.5% 0.38
Oct 19 17:00:00 - 17:59:59 447 2.6% 0.122.4 MB 4.3% 0.67
Oct 19 18:00:00 - 18:59:59 353 2.1% 0.101.1 MB 2.0% 0.31
Oct 19 19:00:00 - 19:59:59 508 3.0% 0.141.7 MB 3.1% 0.48
Oct 19 20:00:00 - 20:59:59 687 4.0% 0.191.8 MB 3.4% 0.53
Oct 19 21:00:00 - 21:59:59 796 4.7% 0.222.0 MB 3.7% 0.58
Oct 19 22:00:00 - 22:59:59 819 4.8% 0.232.5 MB 4.5% 0.70
Oct 19 23:00:00 - 23:58:02 874 5.1% 0.252.6 MB 4.7% 0.76
TOTAL: 24:00:01 16995 100.0% 0.2054.8 MB 100.0% 0.65
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
BUFF01BIG850.0 GB29.2 GB 58.4% 0 0.25 2421.92
BUFF02BIG850.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF03ALT50.0 GB33.6 GB 67.2% 0 0.31 1928.33
BUFF04ALT50.0 GB1.6 MB 0.0% 0 0.00 0.00
BUFF05BIN50.0 GB364.9 MB 0.7% 0 0.0235555.56
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 GB28.5 GB 57.1% 0 0.54 1127.41
TOTAL: 10-500.0 GB91.7 GB 18.3% 1 0.37-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.snarked.org 1594 2 0 10 0 0 0 0 1582
2newsfeed.neva.ru 1500 13 0 7 0 0 0 0 1480
3bbsnz-out.feed.uzoreto.com 627 24 0 1 0 0 0 0 602
4news.albasani.net 478 0 0 13 0 0 0 0 465
5news-out.mixmin.net 456 0 0 11 0 0 0 0 445
6bbs-nz-out.news.weretis.net 404 78 0 41 0 0 0 0 285
7feeder.eternal-september.org 169 0 0 20 0 0 0 0 149
8news.swapon.de 43 0 0 1 0 0 0 0 42
9news-out.aioe.org 40 22 0 10 0 0 0 0 8
10agency-nz-out.news.mb-net.net 26 6 0 11 0 0 0 0 9
11news.redatomik.org 25 0 0 14 0 0 0 0 11
12news.freedyn.net 21 0 0 9 0 0 0 0 12
13news.samoylyk.net 19 0 0 16 0 0 0 0 3
14csiph.com 9 0 0 7 0 0 0 0 2
15feeder.awxg.com 9 0 0 9 0 0 0 0 0
TOTAL: 15 5420 145 0 180 0 0 0 0 5095

Unwanted newsgroups [Top 20]:

NewsgroupCount
gmane.linux.alsa.devel 23
gmane.comp.gis.openstreetmap.tagging 18
mozilla.dev.apps.seamonkey 15
mozilla.support.seamonkey 11
mozilla.dev.security.policy 9
mozilla.dev.ui-alerts 9
alt.music.pink-floyd.publius 9
mozilla.dev.developer-tools 7
gmane.comp.gis.openstreetmap.imports 6
mozilla.dev.platform 4
al.christnet.bible 3
it.annunci.varie 3
it.annunci.commerciali 3
it.annunci.immobiliari 3
gmane.linux.bios.flashrom 3
alt.fan.john 2
fido7.ru.android 2
alt.radio.networks 1
alt.radio.internet 1
mozilla.compatibility 1
TOTAL: 32 145

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 2690
Too many newsgroups 1460
EMP (phn path) 289
EMP (phl) 111
User-issued cancel 73
Binary: non-binary distribution 34
User-issued spam cancel 20
EMP (phn nph) 13
Binary: misplaced par2 5
Binary: misplaced rar 1
TOTAL: 10 4696

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
bbsnz-out.feed.uzoreto.com 3
TOTAL: 1 3
Including strange strings
bbs-nz-out.news.weretis.net 156
news.albasani.net 109
news-out.mixmin.net 54
news.swapon.de 41
bbsnz-out.feed.uzoreto.com 14
news-out.aioe.org 7
news.redatomik.org 5
newsfeed.neva.ru 3
news.snarked.org 3
news.samoylyk.net 2
TOTAL: 11 396
TOTAL: 2 399

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.ausics.org 15550 658 14879 13 0 0 4%23:59:46
2awxg 16661 37 16604 1 0 0 0%23:59:32
3eternal-september 14502 23 14424 2 0 2 0%23:59:43
4news.snarked.org 14339 18 14211 5 0 79 0%23:59:46
5aioe 14527 11 14418 0 0 0 0%23:59:46
6csiph.com 16898 4 16829 1 0 0 0%23:59:46
7weretis.net 12482 3 12341 6 0 1 0%23:59:33
8mb-net.net 16945 0 16890 0 0 59 0%23:59:46
9news.redatomik.org 16643 0 16605 0 0 9 0%23:59:46
10news-in.mixmin.net 15665 0 15645 0 0 2 0%23:59:43
11news.albasani.net 17172 0 14892 717 0 5330 0%23:59:46
12news.uzoreto.com 14666 0 14663 0 0 0 0%23:59:29
13news.swapon.de 1285 0 1285 0 0 0 0%23:51:03
14neva.ru 15626 0 15621 0 0 0 0%23:59:46
15news.freedyn.net 17002 0 16947 0 0 0 0%23:59:32
16news.samoylyk.net 15568 0 15489 0 0 184 0%23:59:46
TOTAL: 16 235531 754 231743 745 0 5666 0%383:46:29
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.ausics.org7.8 MB375.1 KB8.2 MB0.1 KB/s12.5 KB23:59:46
2awxg128.4 KB4.0 KB132.4 KB0.0 KB/s3.5 KB23:59:32
3eternal-september61.3 KB4.8 KB66.1 KB0.0 KB/s2.6 KB23:59:43
4aioe37.3 KB0.0 KB37.3 KB0.0 KB/s3.4 KB23:59:46
5news.snarked.org31.1 KB16.2 KB47.3 KB0.0 KB/s2.1 KB23:59:46
6csiph.com7.1 KB1.1 KB8.2 KB0.0 KB/s1.6 KB23:59:46
7weretis.net7.0 KB9.8 KB16.7 KB0.0 KB/s1.9 KB23:59:33
8mb-net.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:46
9news.redatomik.org0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:46
10news-in.mixmin.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:43
11news.albasani.net0.0 KB2.6 MB2.6 MB0.0 KB/s3.7 KB23:59:46
12news.uzoreto.com0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:29
13news.swapon.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:51:03
14neva.ru0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:46
15news.freedyn.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:32
16news.samoylyk.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:46
TOTAL: 168.1 MB3.0 MB11.0 MB0.0 KB/s7.5 KB383:46:29
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1agency.bbs.nz 384 505317.3 MB 3024 0 000:14:54
2vorlon.activateit.net.au 24 9711.4 MB 144 0 000:09:52
3amigacity.xyz 71 4097.8 KB 27 0 28400:14:08
4160-3-236-103.cpe.cableone.net 2 711.8 KB 3 0 040:17:16
5121.138.128.123 3 511.5 KB 1 0 001:30:25
TOTAL: 5 484 607618.8 MB 3199 0 28443:01:07

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.bbs.nz 384 505317.3 MB 3024 0 000:14:54
2*.activateit.net.au 24 9711.4 MB 144 0 000:09:52
3*.xyz 71 4097.8 KB 27 0 28400:14:08
4*.cpe.cableone.net 2 711.8 KB 3 0 040:17:16
5unresolved 9 511.5 KB 1 0 002:04:43
6*.208-100-26.static.steadfastdns.net 1 00.0 KB 0 0 000:00:01
TOTAL: 6 491 607618.8 MB 3199 0 28443:01:07

NNRP auth users [Top 20]:

UserConn
amigacity 71
amybbs 24
malcolmlewis 2
TOTAL: 3 97

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
160-3-236-103.cpe.cableone.net 0.316 0.120 0.00740:17:16
121.138.128.123 0.148 0.024 0.00001:30:25
175.223.20.196 0.064 0.004 0.00000:30:01
agency.bbs.nz 29.004 6.408 0.00000:14:54
amigacity.xyz 3.948 0.852 0.17800:14:08
vorlon.activateit.net.au 1.408 0.448 0.11800:09:52
118.149.138.177 0.248 0.028 0.00000:04:06
? 0.848 0.080 0.00000:00:12
107.170.212.151 0.056 0.000 0.00000:00:09
ip230.208-100-26.static.steadfastdns.net 0.060 0.008 0.00000:00:01
TOTAL: 10 36.100 7.972 0.30343:01:07

Curious NNRP server explorers [Top 20]:

SystemConn
118.149.138.177 4
175.223.20.196 1
107.170.212.151 1
ip230.208-100-26.static.steadfastdns.net 1
TOTAL: 4 7

NNRP gethostbyaddr failures [Top 20]:

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

NNRP client timeouts [Top 20]:

SystemConnPeer
121.138.128.123 3 0
175.223.20.196 1 0
TOTAL: 2 4 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 2462 40.5%
2uk 727 12.0%
3comp 679 11.2%
4sci 633 10.4%
5soc 553 9.1%
6linux 395 6.5%
7alt 284 4.7%
8talk 220 3.6%
9misc 51 0.8%
10news 19 0.3%
11microsoft 17 0.3%
12nz 16 0.3%
13aus 8 0.1%
14mozilla 7 0.1%
15humanities 5 0.1%
TOTAL: 15 6076100.0%

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

NewsgroupCount
1rec.arts.tv 631
2rec.arts.drwho 383
3uk.d-i-y 271
4rec.sport.tennis 200
5comp.lang.c 176
6linux.debian.bugs.dist 162
7uk.legal 159
8talk.politics.guns 156
9sci.electronics.design 153
10sci.physics 138
11alt.comp.os.windows-10 137
12rec.food.cooking 131
13rec.sport.football.college 129
14rec.sport.pro-wrestling 126
15comp.os.linux.advocacy 119
16uk.radio.amateur 117
17linux.debian.changes.devel 100
18rec.arts.sf.written 96
19soc.culture.israel 89
20rec.boats 85
21rec.arts.sf.tv 78
22soc.culture.indian 69
23soc.retirement 61
24rec.drugs.cannabis 61
25rec.gambling.poker 60
26uk.legal.moderated 58
27comp.lang.c++ 57
28soc.culture.polish 53
29sci.physics.relativity 53
30sci.med.cardiology 47
31talk.origins 46
32linux.debian.bugs.rc 44
33soc.history.living 44
34rec.photo.digital 42
35rec.aviation.soaring 37
36sci.agriculture.beekeeping 36
37soc.culture.greek 36
38sci.lang 33
39alt.politics.trump 33
40alt.conspiracy.jfk 31
41comp.lang.python 31
42rec.music.classical.recordings 31
43uk.radio.amateur.moderated 31
44sci.math 30
45rec.games.backgammon 29
46soc.penpals 28
47rec.pets.cats.community 25
48alt.bbs.synchronet 25
49uk.rec.cycling 25
50sci.crypt 24
51alt.test 24
52comp.sys.raspberry-pi 24
53rec.music.dylan 23
54sci.military.naval 22
55comp.lang.ada 22
56uk.tech.digital-tv 21
57soc.genealogy.medieval 21
58rec.arts.disney.parks 20
59comp.arch 20
60soc.genealogy.britain 19
61sci.astro.amateur 19
62soc.culture.china 19
63rec.autos.sport.f1 18
64sci.logic 18
65rec.audio.opinion 17
66linux.debian.user 17
67nz.general 16
68soc.culture.usa 15
69linux.debian.devel 15
70comp.protocols.dns.bind 15
71microsoft.public.windowsxp.general 15
72talk.politics.misc 15
73linux.debian.user.german 14
74uk.rec.cars.maintenance 14
75rec.sport.soccer 14
76soc.culture.brazil 13
77comp.arch.fpga 13
78misc.survivalism 13
79uk.tech.broadcast 13
80rec.sport.golf 12
81comp.lang.lisp 12
82comp.sys.apple2 12
83misc.health.diabetes 11
84rec.arts.sf.fandom 11
85soc.culture.turkish 10
86rec.games.pinball 10
87news.lists.filters 10
88alt.os.linux.ubuntu 10
89uk.comp.sys.mac 10
90comp.sys.acorn.apps 10
91rec.arts.movies.current-films 9
92sci.physics.electromag 9
93sci.med.pharmacy 9
94soc.history.medieval 9
95soc.culture.europe 9
96rec.crafts.metalworking 8
97rec.radio.amateur.antenna 8
98comp.text.tex 8
99comp.unix.programmer 8
100rec.arts.comics.strips 8
TOTAL: 313 6076