Project

General

Profile

SwarmBox.txt

Nima Mousavi, 10/07/2016 02:42 PM

Download (11.1 KB)

 
1
sbuser@unassigned-hostname:~/src/gdp$ apps/gdp-reader -n 1 -D50 edu.berkeley.cs.                            eric.test.00
2
_gdp_lib_init(NULL)
3
        @(#)libgdp 0.7.2 (2016-10-06 09:17) a69835f590b8b1e2c9c947dee51d22419d03                            5fc5
4
My GDP routing name = l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
5
gdp_lib_init: OK
6
_gdp_chan_open(gdp-01.eecs.berkeley.edu; gdp-02.eecs.berkeley.edu; gdp-03.eecs.b                            erkeley.edu)
7
Trying gdp-01.eecs.berkeley.edu
8
_gdp_chan_open: trying host gdp-01.eecs.berkeley.edu port 8007
9
successful connect
10
_gdp_chan_open: talking to router at gdp-01.eecs.berkeley.edu:8007
11
_gdp_advertise(1):
12
gdp_datum_new => 0x141cf90
13
_gdp_pdu_new => 0x141cf10
14
_gdp_req_new(gcl=(nil), cmd=CMD_ADVERTISE) => 0x141ce10 (rid=0)
15
_gdp_req_send: req@0x141ce10:
16
    nextrec=0, numrecs=0, chan=0x141adc0
17
    postproc=(nil), sub_cb=(nil), udata=(nil)
18
    state=ACTIVE, stat=OK
19
    act_ts=1970-01-01T00:00:00.000000000Z
20
    flags=0x100<ON_CHAN_LIST>
21
    GCL@(nil): NULL
22
    PDU@0x141cf10:
23
        v=3, ttl=15, rsvd1=0, cmd=1=CMD_ADVERTISE
24
        dst=_wD_AP8A_wD_AP8A_wD_AP8A_wD_AP8A_wD_AP8A_wA
25
        src=(none)
26
        rid=0, olen=0, chan=(nil), seqno=0
27
        flags=0
28
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
29
                ts=(none)
30
        sigmdalg=0x0, siglen=0, sig=(nil)
31
        total header=80
32
_gdp_pdu_out, fd = 7, basemd = (nil):
33
    PDU@0x141cf10:
34
        v=3, ttl=15, rsvd1=0, cmd=1=CMD_ADVERTISE
35
        dst=_wD_AP8A_wD_AP8A_wD_AP8A_wD_AP8A_wD_AP8A_wA
36
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
37
        rid=0, olen=0, chan=(nil), seqno=0
38
        flags=0
39
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
40
                ts=(none)
41
        sigmdalg=0x0, siglen=0, sig=(nil)
42
        total header=80
43
_gdp_pdu_out: sending PDU:
44
00000000 03 0f 00 01 ff 00 ff 00 ff 00 ff 00 ff 00 ff 00
45
00000010 ff 00 ff 00 ff 00 ff 00 ff 00 ff 00 ff 00 ff 00
46
00000020 ff 00 ff 00 97 8a 96 1b cd c9 25 07 2e f2 7c ad
47
00000030 ee 4c 03 4e 9d c8 bb 34 b0 62 b6 27 bd fc 17 ce
48
00000040 14 21 50 fd 00 00 00 00 00 00 00 00 00 00 00 00
49
_gdp_req_free(0x141ce10)  state=1, gcl=(nil)
50
_gdp_pdu_free(0x141cf10)
51
gdp_datum_free(0x141cf90)
52
  ... draining 0 bytes
53
_gdp_advertise => OK
54
gdp_init: OK
55
gdp_event_loop: starting up I/O base loop
56
Inserted events:
57
  0x141a9d0 [fd 6] Read Persist
58
  0x141ae70 [fd 7] Read Persist
59
  0x141aef8 [fd 7] Write Persist
60
Reading GCL gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
61

    
62
>>> gdp_gcl_open
63
gdp_gcl_cache_get: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM => NULL
64
_gdp_gcl_newhandle => 0x141d120 (gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM)
65
gdp_datum_new => 0x141cf90
66
_gdp_pdu_new => 0x141cf10
67
_gdp_req_new(gcl=0x141d120, cmd=CMD_OPEN_RO) => 0x141ce10 (rid=1)
68

    
69
>>> _gdp_invoke(req=0x141ce10 rid=1): CMD_OPEN_RO (68), gcl@0x141d120
70
        datum @ 0x141cf90: recno -1, len 0, no timestamp
71
_gdp_invoke: sending 68, retries=2
72
_gdp_req_send: req@0x141ce10:
73
    nextrec=0, numrecs=0, chan=0x141adc0
74
    postproc=(nil), sub_cb=(nil), udata=(nil)
75
    state=ACTIVE, stat=OK
76
    act_ts=1970-01-01T00:00:00.000000000Z
77
    flags=0x540<ALLOC_RID,ON_CHAN_LIST,ROUTEFAIL>
78
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
79
        iomode = 1, refcnt = 1, reqs = (nil), nrecs = 0
80
        flags = 0x8<INUSE>
81
    PDU@0x141cf10:
82
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
83
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
84
        src=(none)
85
        rid=1, olen=0, chan=(nil), seqno=0
86
        flags=0
87
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
88
                ts=(none)
89
        sigmdalg=0x0, siglen=0, sig=(nil)
90
        total header=80
91
_gdp_gcl_cache_add: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM => 0x141d120
92
_gdp_pdu_out, fd = 7, basemd = (nil):
93
    PDU@0x141cf10:
94
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
95
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
96
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
97
        rid=1, olen=0, chan=(nil), seqno=0
98
        flags=0
99
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
100
                ts=(none)
101
        sigmdalg=0x0, siglen=0, sig=(nil)
102
        total header=80
103
_gdp_pdu_out: sending PDU:
104
00000000 03 0f 00 44 80 95 83 56 0f e2 e2 04 a5 95 89 a3
105
00000010 c1 1e 1c 9c e8 f3 d6 08 78 f4 3a ac fe 8a 3c 3f
106
00000020 f1 c1 54 23 97 8a 96 1b cd c9 25 07 2e f2 7c ad
107
00000030 ee 4c 03 4e 9d c8 bb 34 b0 62 b6 27 bd fc 17 ce
108
00000040 14 21 50 fd 00 00 00 01 00 00 00 00 00 00 00 00
109
_gdp_invoke: waiting on 0x141ce10
110
_gdp_req_unsend: req@0x141ce10:
111
    nextrec=0, numrecs=0, chan=0x141adc0
112
    postproc=(nil), sub_cb=(nil), udata=(nil)
113
    state=ACTIVE, stat=OK
114
    act_ts=1970-01-01T00:00:00.000000000Z
115
    flags=0x5c0<ALLOC_RID,ON_GCL_LIST,ON_CHAN_LIST,ROUTEFAIL>
116
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
117
        iomode = 1, refcnt = 1, reqs = 0x141ce10, nrecs = 0
118
        flags = 0xa<INCACHE,INUSE>
119
    PDU@0x141cf10:
120
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
121
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
122
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
123
        rid=1, olen=0, chan=(nil), seqno=0
124
        flags=0
125
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
126
                ts=(none)
127
        sigmdalg=0x0, siglen=0, sig=(nil)
128
        total header=80
129
_gdp_invoke: sending 68, retries=1
130
_gdp_req_send: req@0x141ce10:
131
    nextrec=0, numrecs=0, chan=0x141adc0
132
    postproc=(nil), sub_cb=(nil), udata=(nil)
133
    state=ACTIVE, stat=OK
134
    act_ts=1970-01-01T00:00:00.000000000Z
135
    flags=0x540<ALLOC_RID,ON_CHAN_LIST,ROUTEFAIL>
136
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
137
        iomode = 1, refcnt = 1, reqs = (nil), nrecs = 0
138
        flags = 0xa<INCACHE,INUSE>
139
    PDU@0x141cf10:
140
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
141
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
142
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
143
        rid=1, olen=0, chan=(nil), seqno=0
144
        flags=0
145
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
146
                ts=(none)
147
        sigmdalg=0x0, siglen=0, sig=(nil)
148
        total header=80
149
_gdp_gcl_cache_add(0x141d120): already cached
150
_gdp_pdu_out, fd = 7, basemd = (nil):
151
    PDU@0x141cf10:
152
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
153
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
154
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
155
        rid=1, olen=0, chan=(nil), seqno=0
156
        flags=0
157
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
158
                ts=(none)
159
        sigmdalg=0x0, siglen=0, sig=(nil)
160
        total header=80
161
_gdp_pdu_out: sending PDU:
162
00000000 03 0f 00 44 80 95 83 56 0f e2 e2 04 a5 95 89 a3
163
00000010 c1 1e 1c 9c e8 f3 d6 08 78 f4 3a ac fe 8a 3c 3f
164
00000020 f1 c1 54 23 97 8a 96 1b cd c9 25 07 2e f2 7c ad
165
00000030 ee 4c 03 4e 9d c8 bb 34 b0 62 b6 27 bd fc 17 ce
166
00000040 14 21 50 fd 00 00 00 01 00 00 00 00 00 00 00 00
167
_gdp_invoke: waiting on 0x141ce10
168
_gdp_req_unsend: req@0x141ce10:
169
    nextrec=0, numrecs=0, chan=0x141adc0
170
    postproc=(nil), sub_cb=(nil), udata=(nil)
171
    state=ACTIVE, stat=OK
172
    act_ts=1970-01-01T00:00:00.000000000Z
173
    flags=0x5c0<ALLOC_RID,ON_GCL_LIST,ON_CHAN_LIST,ROUTEFAIL>
174
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
175
        iomode = 1, refcnt = 1, reqs = 0x141ce10, nrecs = 0
176
        flags = 0xa<INCACHE,INUSE>
177
    PDU@0x141cf10:
178
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
179
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
180
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
181
        rid=1, olen=0, chan=(nil), seqno=0
182
        flags=0
183
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
184
                ts=(none)
185
        sigmdalg=0x0, siglen=0, sig=(nil)
186
        total header=80
187
_gdp_invoke: sending 68, retries=0
188
_gdp_req_send: req@0x141ce10:
189
    nextrec=0, numrecs=0, chan=0x141adc0
190
    postproc=(nil), sub_cb=(nil), udata=(nil)
191
    state=ACTIVE, stat=OK
192
    act_ts=1970-01-01T00:00:00.000000000Z
193
    flags=0x540<ALLOC_RID,ON_CHAN_LIST,ROUTEFAIL>
194
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
195
        iomode = 1, refcnt = 1, reqs = (nil), nrecs = 0
196
        flags = 0xa<INCACHE,INUSE>
197
    PDU@0x141cf10:
198
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
199
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
200
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
201
        rid=1, olen=0, chan=(nil), seqno=0
202
        flags=0
203
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
204
                ts=(none)
205
        sigmdalg=0x0, siglen=0, sig=(nil)
206
        total header=80
207
_gdp_gcl_cache_add(0x141d120): already cached
208
_gdp_pdu_out, fd = 7, basemd = (nil):
209
    PDU@0x141cf10:
210
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
211
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
212
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
213
        rid=1, olen=0, chan=(nil), seqno=0
214
        flags=0
215
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
216
                ts=(none)
217
        sigmdalg=0x0, siglen=0, sig=(nil)
218
        total header=80
219
_gdp_pdu_out: sending PDU:
220
00000000 03 0f 00 44 80 95 83 56 0f e2 e2 04 a5 95 89 a3
221
00000010 c1 1e 1c 9c e8 f3 d6 08 78 f4 3a ac fe 8a 3c 3f
222
00000020 f1 c1 54 23 97 8a 96 1b cd c9 25 07 2e f2 7c ad
223
00000030 ee 4c 03 4e 9d c8 bb 34 b0 62 b6 27 bd fc 17 ce
224
00000040 14 21 50 fd 00 00 00 01 00 00 00 00 00 00 00 00
225
_gdp_invoke: waiting on 0x141ce10
226
_gdp_event_trigger_pending(0x141cef8): empty
227
<<< _gdp_invoke(0x141ce10 rid=1) CMD_OPEN_RO: ERROR: Connection timed out [EPLIB:errno:110]
228
  req@0x141ce10:
229
    nextrec=0, numrecs=0, chan=0x141adc0
230
    postproc=(nil), sub_cb=(nil), udata=(nil)
231
    state=ACTIVE, stat=OK
232
    act_ts=1970-01-01T00:00:00.000000000Z
233
    flags=0x5c0<ALLOC_RID,ON_GCL_LIST,ON_CHAN_LIST,ROUTEFAIL>
234
    GCL@0x141d120: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
235
        iomode = 1, refcnt = 1, reqs = 0x141ce10, nrecs = 0
236
        flags = 0xa<INCACHE,INUSE>
237
    PDU@0x141cf10:
238
        v=3, ttl=15, rsvd1=0, cmd=68=CMD_OPEN_RO
239
        dst=gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM
240
        src=l4qWG83JJQcu8nyt7kwDTp3IuzSwYrYnvfwXzhQhUP0
241
        rid=1, olen=0, chan=(nil), seqno=0
242
        flags=0
243
        datum=0x141cf90, recno=(none), dbuf=0x141d000, dlen=0
244
                ts=(none)
245
        sigmdalg=0x0, siglen=0, sig=(nil)
246
        total header=80
247

    
248
_gdp_req_free(0x141ce10)  state=1, gcl=(nil)
249
_gdp_pdu_free(0x141cf10)
250
gdp_datum_free(0x141cf90)
251
  ... draining 0 bytes
252
Couldn't open GCL gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM:
253
        ERROR: Connection timed out [EPLIB:errno:110]
254
_gdp_gcl_freehandle(0x141d120)
255
>>> _gdp_req_freeall(0x141d160)
256
2016-10-07 14:39:37.850594 -0700 gdp-reader: _gdp_req_freeall: couldn't acquire req lock: ERROR: request freed while in use [Berkeley:Swarm-GDP:31]
257

    
258
<<< _gdp_req_freeall(0x141d160): ERROR: request freed while in use [Berkeley:Swarm-GDP:31]
259
_gdp_gcl_cache_drop: gJWDVg_i4gSllYmjwR4cnOjz1gh49Dqs_oo8P_HBVCM => 0x141d120
260
[ERROR] gdp-reader: Cannot open GCL:
261
    ERROR: Connection timed out [EPLIB:errno:110]
262
exiting after 0 records with status ERROR: Connection timed out [EPLIB:errno:110]