Daily Usenet report for news.ripco.com

Feb 25 00:01:02 -- Feb 25 23:57:43

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Feb 25 03:03:31 remote5bge0 overchan[29192]: [ID 702911 news.error] input line too long, skipping
Feb 25 03:15:29 remote5bge0 overchan[29192]: [ID 702911 news.error] input line too long, skipping
Feb 25 08:35:37 remote5bge0 overchan[29192]: [ID 702911 news.error] input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 19044 32.1%2.0 MB 22.6%
inn 18995 32.0%3.4 MB 37.9%
innd 17995 30.3%2.8 MB 31.5%
innfeed 3368 5.7%734.8 KB 8.0%
overchan 3 0.0%0.4 KB 0.0%
controlchan 2 0.0%0.2 KB 0.0%
TOTAL: 6 59407 100.0%8.9 MB100.0%

History cache:

ReasonCount%Count
Do not exist 158614 51.9%
Cache misses 147218 48.1%
Negative hits 0 0.0%
Positive hits 0 0.0%
TOTAL: 4 305832 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.000 0.0%150 0.000 0.000 0.000
article cleanup00:00:00.346 0.0%37332 0.000 0.009 0.048
article logging00:00:00.540 0.0%37878 0.000 0.014 0.197
article parse00:00:01.384 0.0%96280 0.000 0.014 0.038
article write00:01:10.882 0.0%29648 0.936 2.391 169.500
artlog/artparse00:00:00.000 0.0%36 0.000 0.000 0.000
data move00:00:00.224 0.0%320610 0.000 0.001 0.005
hishave/artparse00:00:00.000 0.0%14 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:02.698 0.0%306404 0.002 0.009 0.019
history sync00:00:00.184 0.0%774 0.000 0.238 1.000
history write00:00:02.522 0.0%37354 0.000 0.068 0.870
hiswrite/artparse00:00:00.000 0.0%14 0.000 0.000 0.000
idle47:38:47.790 99.9%356268 244.153 481.457 1600.120
nntp read00:00:02.028 0.0%356432 0.000 0.006 0.016
overview write00:00:00.194 0.0%29648 0.000 0.007 0.038
perl filter00:00:55.032 0.0%37332 1.091 1.474 2.504
python filter00:00:01.006 0.0%37340 0.000 0.027 0.076
site send00:00:02.436 0.0%88920 0.004 0.027 0.057
TOTAL: 47:42:02.02647:41:07.266100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.076 0.0%29666 0.000 0.003 0.024
article prepare00:00:00.006 0.0%42184 0.000 0.000 0.011
article read00:00:00.808 0.0%6396 0.000 0.126 12.167
backlog stats00:00:00.188 0.0%387206 0.000 0.000 0.002
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.222 0.0%247712 0.000 0.005 0.015
data write00:00:03.876 0.0%218094 0.009 0.018 0.031
idle47:34:32.888100.0%387206 258.321 442.330 1657.376
status file00:00:01.848 0.0%378 0.000 4.889 31.000
TOTAL: 47:34:48.64447:34:40.912100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle02:05:36.000 97.5%18092 19.583 416.538 38810.842
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:06.244 0.1%646634 0.000 0.010 1.000
readart00:00:20.694 0.3%2032 0.000 10.184 36.000
TOTAL: 02:08:47.54202:06:02.938 97.9%----

Control commands to INND:

CommandNumber
L 2
flush 2
go 4
logmode 2
mode 6
name 5
pause 2
paused 2
reserve 4
TOTAL: 9 29

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1ripco-out.feed.uzoreto.com 1148 29810 9396 17188 3226 31%94:48:36
2news.snarked.org 44 26504 8252 17738 514 31%53:54:50
3feeder3.feed-ams.uzoreto.com 574 18486 5808 10912 1766 31%47:19:46
4newsfeed.neva.ru 594 36858 5018 30636 1204 13%273:06:42
5newsfeed.fu-berlin.de 2 12764 774 11950 40 6%44:30:14
6news-in.rahul.net 574 13944 190 13716 38 1%47:20:00
7news.lightlink.com 2 3692 96 3412 184 2%28:34:50
8news.cmpublishers.com 52 7824 34 7778 12 0%47:59:44
9ripco-out.feeder.erje.net 574 31420 30 30682 708 0%47:17:20
10localhost 154 8 8 0 0 100%00:00:00
TOTAL: 10 3718 181310 29606 144012 7692 16%684:52:02
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.snarked.org23.3 MB0.0 KB1.8 MB25.1 MB 92%2.9 KB
2ripco-out.feed.uzoreto.com22.5 MB0.0 KB7.3 MB29.8 MB 75%2.4 KB
3newsfeed.neva.ru15.5 MB0.0 KB3.8 MB19.3 MB 80%3.2 KB
4feeder3.feed-ams.uzoreto.com14.0 MB0.0 KB4.8 MB18.8 MB 74%2.5 KB
5news-in.rahul.net8.8 MB0.0 KB542.1 KB9.3 MB 94%41.8 KB
6newsfeed.fu-berlin.de5.3 MB0.0 KB13.6 MB18.9 MB 27%23.8 KB
7news.lightlink.com594.9 KB0.0 KB7.1 MB7.7 MB 7%28.2 KB
8news.cmpublishers.com124.8 KB0.0 KB21.6 KB146.4 KB 85%3.2 KB
9ripco-out.feeder.erje.net115.2 KB0.0 KB5.9 MB6.0 MB 1%8.3 KB
10localhost21.6 KB0.0 KB0.0 KB21.6 KB100%2.7 KB
TOTAL: 1090.2 MB0.0 KB44.9 MB135.1 MB 66%3.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Feb 25 00:01:02 - 00:59:59 351 2.4% 0.10989.9 KB 2.1% 0.28
Feb 25 01:00:00 - 01:59:59 485 3.3% 0.131.3 MB 2.8% 0.37
Feb 25 02:00:00 - 02:59:59 609 4.1% 0.171.7 MB 3.8% 0.50
Feb 25 03:00:00 - 03:59:59 656 4.4% 0.181.6 MB 3.5% 0.45
Feb 25 04:00:00 - 04:59:59 698 4.7% 0.191.9 MB 4.2% 0.54
Feb 25 05:00:00 - 05:59:59 788 5.3% 0.222.6 MB 5.6% 0.73
Feb 25 06:00:00 - 06:59:59 734 4.9% 0.202.2 MB 4.8% 0.62
Feb 25 07:00:00 - 07:59:59 743 5.0% 0.211.9 MB 4.2% 0.55
Feb 25 08:00:00 - 08:59:59 730 4.9% 0.202.8 MB 6.1% 0.79
Feb 25 09:00:00 - 09:59:59 755 5.1% 0.212.1 MB 4.6% 0.59
Feb 25 10:00:00 - 10:59:59 875 5.9% 0.243.4 MB 7.4% 0.96
Feb 25 11:00:00 - 11:59:59 879 5.9% 0.242.5 MB 5.4% 0.70
Feb 25 12:00:00 - 12:59:59 823 5.5% 0.232.1 MB 4.5% 0.59
Feb 25 13:00:00 - 13:59:59 904 6.1% 0.253.0 MB 6.5% 0.84
Feb 25 14:00:00 - 14:59:59 830 5.6% 0.232.6 MB 5.6% 0.73
Feb 25 15:00:00 - 15:59:59 710 4.8% 0.202.2 MB 4.7% 0.61
Feb 25 16:00:00 - 16:59:59 662 4.5% 0.181.9 MB 4.2% 0.55
Feb 25 17:00:00 - 17:59:59 552 3.7% 0.151.6 MB 3.4% 0.44
Feb 25 18:00:00 - 18:59:59 408 2.7% 0.111.9 MB 4.2% 0.54
Feb 25 19:00:00 - 19:59:59 439 3.0% 0.121.4 MB 3.0% 0.39
Feb 25 20:00:00 - 20:59:59 383 2.6% 0.111.2 MB 2.7% 0.35
Feb 25 21:00:00 - 21:59:59 298 2.0% 0.08859.9 KB 1.8% 0.24
Feb 25 22:00:00 - 22:59:59 223 1.5% 0.06831.2 KB 1.8% 0.23
Feb 25 23:00:00 - 23:57:43 310 2.1% 0.091.4 MB 3.1% 0.42
TOTAL: 23:56:41 14845 100.0% 0.1745.7 MB 100.0% 0.54
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1ripco-out.feed.uzoreto.com 1628 1206 0 0 4 0 0 0 418
2feeder3.feed-ams.uzoreto.com 883 506 0 0 1 0 0 0 376
3newsfeed.neva.ru 659 334 0 0 0 0 0 0 325
4ripco-out.feeder.erje.net 354 349 0 0 0 0 0 0 5
5news.snarked.org 265 153 0 0 1 0 0 0 111
6newsfeed.fu-berlin.de 220 0 0 0 0 0 0 0 220
7news.lightlink.com 117 0 0 0 0 0 0 0 117
8news-in.rahul.net 19 4 0 0 0 0 0 0 15
9news.cmpublishers.com 5 1 0 0 0 0 0 0 4
TOTAL: 9 4150 2553 0 0 6 0 0 0 1591

Unwanted newsgroups [Top 20]:

NewsgroupCount
free.usenet 1797
alt.binaries.ftd 110
scot.general 53
alt.binaries.howard-stern 44
it.tlc.cellulari.android 38
fido7.su.pol.news 38
free.it.scienza.fisica 35
perl.cpan.uploads 31
alt.binaries.nl 30
alt.binaries.e-book 28
it.comp.os.win.windows10 25
alt.binaries.backup 24
alt.binaries.e-books 13
linux.debian.changes 11
alt.binaries.pictures.rail 11
alt.binaries.pictures.purebeauty 10
alt.binaries.humor.skewed 9
wales.test 8
alt.binaries.adan 7
alt.binaries.movies.xvid 7
TOTAL: 131 2553

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

GroupsCount
christnet.bible 3
gnu.bash.bug 1
fr.comp.applications.libres 1
bit.listserv.catholic 1
TOTAL: 4 6

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 1248
Too many newsgroups 1028
Binary in non-binary group 142
EMP (phl) 114
Scoring filter (10) 18
Scoring filter (8) 18
Scoring filter (9) 16
Scoring filter (12) 6
Scoring filter (18) 4
Scoring filter (11) 4
Scoring filter (14) 2
TOTAL: 11 2600

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad Message-ID's offered
ripco-out.feeder.erje.net 18
TOTAL: 1 18
Huge articles
newsfeed.fu-berlin.de 14
TOTAL: 1 14
Including strange strings
newsfeed.fu-berlin.de 198
newsfeed.neva.ru 52
ripco-out.feed.uzoreto.com 14
news.snarked.org 9
TOTAL: 4 273
No colon-space in header
ripco-out.feed.uzoreto.com 6
ripco-out.feeder.erje.net 4
feeder3.feed-ams.uzoreto.com 1
TOTAL: 3 11
TOTAL: 4 316

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1feeder.erje.net 32708 2948 22996 2278 0 6 9%47:34:22
2news.lightlink.com 8912 1782 4716 4 0 0 19%47:50:06
3rahul.net 23092 684 12200 10 0 0 2%47:40:00
4news.cmpublishers.com 41830 260 26790 2262 0 20 0%47:34:10
5news.uzoreto.com 14468 62 13992 134 0 0 0%47:34:24
6news.snarked.org 36154 48 20912 18 0 66 0%47:40:00
7fu-berlin.de 26980 20 26960 0 0 0 0%47:50:30
8newsfeed.neva.ru 24892 16 24492 12 0 0 0%47:33:58
9remote6hme0.ripco.com 12 6 0 6 0 0 50%02:12:06
TOTAL: 9 209048 5826 153058 4724 0 92 2%383:29:36
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1feeder.erje.net7.5 MB5.6 MB13.1 MB0.1 KB/s2.6 KB47:34:22
2news.lightlink.com5.4 MB10.9 KB5.4 MB0.0 KB/s3.1 KB47:50:06
3rahul.net2.4 MB15.4 KB2.4 MB0.0 KB/s3.6 KB47:40:00
4news.cmpublishers.com752.2 KB5.4 MB6.2 MB0.0 KB/s2.5 KB47:34:10
5news.uzoreto.com190.4 KB445.3 KB635.7 KB0.0 KB/s3.2 KB47:34:24
6news.snarked.org129.5 KB43.2 KB172.7 KB0.0 KB/s2.6 KB47:40:00
7fu-berlin.de67.8 KB0.0 KB67.8 KB0.0 KB/s3.4 KB47:50:30
8newsfeed.neva.ru65.2 KB25.0 KB90.2 KB0.0 KB/s3.2 KB47:33:58
9remote6hme0.ripco.com8.4 KB33.1 KB41.6 KB0.0 KB/s3.5 KB02:12:06
TOTAL: 916.4 MB11.6 MB28.1 MB0.0 KB/s2.7 KB383:29:36
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1ftupet.com 286 8002.2 MB 412 2 000:07:31
2shell3 24 4301.2 MB 46 6 001:59:15
TOTAL: 2 310 12303.3 MB 458 8 002:08:31

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.com 286 8002.2 MB 412 2 000:07:31
2? 24 4301.2 MB 46 6 001:59:15
TOTAL: 2 310 12303.3 MB 458 8 002:06:46

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
shell3 4.886 2.640 0.00001:59:15
ftupet.com 46.330 7.632 0.00000:07:31
84-105-134-55.cable.dynamic.v4.ziggo.nl 44.084 9.812 0.00000:01:43
scan-141.security.ipip.net 0.200 0.048 0.00000:00:00
192.241.232.88 0.200 0.040 0.00000:00:00
worker-18.sfj.corp.censys.io 0.198 0.042 0.00000:00:00
TOTAL: 6 95.898 20.214 0.00002:08:31

NNRP no permission clients:

SystemConn
84-105-134-55.cable.dynamic.v4.ziggo.nl 438
scan-141.security.ipip.net 2
192.241.232.88 2
worker-18.sfj.corp.censys.io 2
TOTAL: 4 444

NNRP unrecognized commands (by host):

SystemConn
shell3 10
TOTAL: 1 10

NNRP unrecognized commands (by command):

CommandCount
XTHREAD DBINIT 10
TOTAL: 1 10

NNRP client timeouts [Top 20]:

SystemConnPeer
shell3 2 0
TOTAL: 1 2 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 964 78.4%
2comp 116 9.4%
3misc 52 4.2%
4alt 46 3.7%
5sci 22 1.8%
6chi 20 1.6%
7news 10 0.8%
TOTAL: 7 1230100.0%

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

NewsgroupCount
1rec.arts.tv 468
2rec.food.cooking 364
3rec.bicycles.tech 112
4comp.sys.mac.system 88
5misc.phone.mobile.iphone 48
6alt.stupidity 32
7sci.electronics.repair 22
8comp.mobile.ipad 16
9chi.forsale 14
10rec.radio.broadcasting 10
11alt.free.newsservers 10
12chi.weather 6
13comp.protocols.dns.bind 6
14news.software.readers 4
15comp.security.ssh 4
16rec.outdoors.rv-travel 4
17rec.gardens.edible 4
18news.software.nntp 4
19misc.consumers.frugal-living 4
20comp.sys.mac.apps 2
21rec.radio.swap 2
22news.admin.net-abuse.usenet 2
23alt.security.alarms 2
24alt.satellite.gps.garmin 2
TOTAL: 24 1230