_ Git - rust-lightning/blob - fuzz/fuzz_targets/full_stack_target.rs

   1 extern crate bitcoin;
   2 extern crate crypto;
   3 extern crate lightning;
   4 extern crate secp256k1;
   5
   6 use bitcoin::blockdata::block::BlockHeader;
   7 use bitcoin::blockdata::transaction::{Transaction, TxOut};
   8 use bitcoin::blockdata::script::Script;
   9 use bitcoin::network::constants::Network;
  10 use bitcoin::network::serialize::{deserialize, serialize, BitcoinHash};
  11 use bitcoin::util::hash::Sha256dHash;
  12
  13 use crypto::digest::Digest;
  14
  15 use lightning::chain::chaininterface::{BroadcasterInterface,ConfirmationTarget,ChainListener,FeeEstimator,ChainWatchInterfaceUtil};
  16 use lightning::chain::transaction::OutPoint;
  17 use lightning::ln::channelmonitor;
  18 use lightning::ln::channelmanager::ChannelManager;
  19 use lightning::ln::peer_handler::{MessageHandler,PeerManager,SocketDescriptor};
  20 use lightning::ln::router::Router;
  21 use lightning::util::events::{EventsProvider,Event};
  22 use lightning::util::reset_rng_state;
  23 use lightning::util::logger::Logger;
  24 use lightning::util::sha2::Sha256;
  25
  26 mod utils;
  27
  28 use utils::test_logger;
  29
  30 use secp256k1::key::{PublicKey,SecretKey};
  31 use secp256k1::Secp256k1;
  32
  33 use std::cell::RefCell;
  34 use std::collections::HashMap;
  35 use std::cmp;
  36 use std::hash::Hash;
  37 use std::sync::Arc;
  38 use std::sync::atomic::{AtomicUsize,Ordering};
  39
  40 #[inline]
  41 pub fn slice_to_be16(v: &[u8]) -> u16 {
  42         ((v[0] as u16) << 8*1) |
  43         ((v[1] as u16) << 8*0)
  44 }
  45
  46 #[inline]
  47 pub fn slice_to_be24(v: &[u8]) -> u32 {
  48         ((v[0] as u32) << 8*2) |
  49         ((v[1] as u32) << 8*1) |
  50         ((v[2] as u32) << 8*0)
  51 }
  52
  53 #[inline]
  54 pub fn slice_to_be32(v: &[u8]) -> u32 {
  55         ((v[0] as u32) << 8*3) |
  56         ((v[1] as u32) << 8*2) |
  57         ((v[2] as u32) << 8*1) |
  58         ((v[3] as u32) << 8*0)
  59 }
  60
  61 #[inline]
  62 pub fn be64_to_array(u: u64) -> [u8; 8] {
  63         let mut v = [0; 8];
  64         v[0] = ((u >> 8*7) & 0xff) as u8;
  65         v[1] = ((u >> 8*6) & 0xff) as u8;
  66         v[2] = ((u >> 8*5) & 0xff) as u8;
  67         v[3] = ((u >> 8*4) & 0xff) as u8;
  68         v[4] = ((u >> 8*3) & 0xff) as u8;
  69         v[5] = ((u >> 8*2) & 0xff) as u8;
  70         v[6] = ((u >> 8*1) & 0xff) as u8;
  71         v[7] = ((u >> 8*0) & 0xff) as u8;
  72         v
  73 }
  74
  75 struct InputData {
  76         data: Vec<u8>,
  77         read_pos: AtomicUsize,
  78 }
  79 impl InputData {
  80         fn get_slice(&self, len: usize) -> Option<&[u8]> {
  81                 let old_pos = self.read_pos.fetch_add(len, Ordering::AcqRel);
  82                 if self.data.len() < old_pos + len {
  83                         return None;
  84                 }
  85                 Some(&self.data[old_pos..old_pos + len])
  86         }
  87 }
  88
  89 struct FuzzEstimator {
  90         input: Arc<InputData>,
  91 }
  92 impl FeeEstimator for FuzzEstimator {
  93         fn get_est_sat_per_1000_weight(&self, _: ConfirmationTarget) -> u64 {
  94                 //TODO: We should actually be testing at least much more than 64k...
  95                 match self.input.get_slice(2) {
  96                         Some(slice) => cmp::max(slice_to_be16(slice) as u64, 253),
  97                         None => 0
  98                 }
  99         }
 100 }
 101
 102 struct TestBroadcaster {}
 103 impl BroadcasterInterface for TestBroadcaster {
 104         fn broadcast_transaction(&self, _tx: &Transaction) {}
 105 }
 106
 107 #[derive(Clone)]
 108 struct Peer<'a> {
 109         id: u8,
 110         peers_connected: &'a RefCell<[bool; 256]>,
 111 }
 112 impl<'a> SocketDescriptor for Peer<'a> {
 113         fn send_data(&mut self, data: &Vec<u8>, write_offset: usize, _resume_read: bool) -> usize {
 114                 assert!(write_offset < data.len());
 115                 data.len() - write_offset
 116         }
 117         fn disconnect_socket(&mut self) {
 118                 assert!(self.peers_connected.borrow()[self.id as usize]);
 119                 self.peers_connected.borrow_mut()[self.id as usize] = false;
 120         }
 121 }
 122 impl<'a> PartialEq for Peer<'a> {
 123         fn eq(&self, other: &Self) -> bool {
 124                 self.id == other.id
 125         }
 126 }
 127 impl<'a> Eq for Peer<'a> {}
 128 impl<'a> Hash for Peer<'a> {
 129         fn hash<H : std::hash::Hasher>(&self, h: &mut H) {
 130                 self.id.hash(h)
 131         }
 132 }
 133
 134 struct MoneyLossDetector<'a> {
 135         manager: Arc<ChannelManager>,
 136         monitor: Arc<channelmonitor::SimpleManyChannelMonitor<OutPoint>>,
 137         handler: PeerManager<Peer<'a>>,
 138
 139         peers: &'a RefCell<[bool; 256]>,
 140         funding_txn: Vec<Transaction>,
 141         header_hashes: Vec<Sha256dHash>,
 142         height: usize,
 143         max_height: usize,
 144
 145 }
 146 impl<'a> MoneyLossDetector<'a> {
 147         pub fn new(peers: &'a RefCell<[bool; 256]>, manager: Arc<ChannelManager>, monitor: Arc<channelmonitor::SimpleManyChannelMonitor<OutPoint>>, handler: PeerManager<Peer<'a>>) -> Self {
 148                 MoneyLossDetector {
 149                         manager,
 150                         monitor,
 151                         handler,
 152
 153                         peers,
 154                         funding_txn: Vec::new(),
 155                         header_hashes: vec![Default::default()],
 156                         height: 0,
 157                         max_height: 0,
 158                 }
 159         }
 160
 161         fn connect_block(&mut self, txn: &[&Transaction], txn_idxs: &[u32]) {
 162                 let header = BlockHeader { version: 0x20000000, prev_blockhash: self.header_hashes[self.height], merkle_root: Default::default(), time: 42, bits: 42, nonce: 42 };
 163                 self.height += 1;
 164                 self.manager.block_connected(&header, self.height as u32, txn, txn_idxs);
 165                 (*self.monitor).block_connected(&header, self.height as u32, txn, txn_idxs);
 166                 if self.header_hashes.len() > self.height {
 167                         self.header_hashes[self.height] = header.bitcoin_hash();
 168                 } else {
 169                         assert_eq!(self.header_hashes.len(), self.height);
 170                         self.header_hashes.push(header.bitcoin_hash());
 171                 }
 172                 self.max_height = cmp::max(self.height, self.max_height);
 173         }
 174
 175         fn disconnect_block(&mut self) {
 176                 if self.height > 0 && (self.max_height < 6 || self.height >= self.max_height - 6) {
 177                         self.height -= 1;
 178                         let header = BlockHeader { version: 0x20000000, prev_blockhash: self.header_hashes[self.height], merkle_root: Default::default(), time: 42, bits: 42, nonce: 42 };
 179                         self.manager.block_disconnected(&header);
 180                         self.monitor.block_disconnected(&header);
 181                 }
 182         }
 183 }
 184
 185 impl<'a> Drop for MoneyLossDetector<'a> {
 186         fn drop(&mut self) {
 187                 // Disconnect all peers
 188                 for (idx, peer) in self.peers.borrow().iter().enumerate() {
 189                         if *peer {
 190                                 self.handler.disconnect_event(&Peer{id: idx as u8, peers_connected: &self.peers});
 191                         }
 192                 }
 193
 194                 // Force all channels onto the chain (and time out claim txn)
 195                 self.manager.force_close_all_channels();
 196         }
 197 }
 198
 199 #[inline]
 200 pub fn do_test(data: &[u8], logger: &Arc<Logger>) {
 201         reset_rng_state();
 202
 203         let input = Arc::new(InputData {
 204                 data: data.to_vec(),
 205                 read_pos: AtomicUsize::new(0),
 206         });
 207         let fee_est = Arc::new(FuzzEstimator {
 208                 input: input.clone(),
 209         });
 210
 211         macro_rules! get_slice {
 212                 ($len: expr) => {
 213                         match input.get_slice($len as usize) {
 214                                 Some(slice) => slice,
 215                                 None => return,
 216                         }
 217                 }
 218         }
 219
 220         let secp_ctx = Secp256k1::new();
 221         macro_rules! get_pubkey {
 222                 () => {
 223                         match PublicKey::from_slice(&secp_ctx, get_slice!(33)) {
 224                                 Ok(key) => key,
 225                                 Err(_) => return,
 226                         }
 227                 }
 228         }
 229
 230         let our_network_key = match SecretKey::from_slice(&secp_ctx, get_slice!(32)) {
 231                 Ok(key) => key,
 232                 Err(_) => return,
 233         };
 234
 235         let watch = Arc::new(ChainWatchInterfaceUtil::new(Arc::clone(&logger)));
 236         let broadcast = Arc::new(TestBroadcaster{});
 237         let monitor = channelmonitor::SimpleManyChannelMonitor::new(watch.clone(), broadcast.clone());
 238
 239         let channelmanager = ChannelManager::new(our_network_key, slice_to_be32(get_slice!(4)), get_slice!(1)[0] != 0, Network::Bitcoin, fee_est.clone(), monitor.clone(), watch.clone(), broadcast.clone(), Arc::clone(&logger)).unwrap();
 240         let router = Arc::new(Router::new(PublicKey::from_secret_key(&secp_ctx, &our_network_key).unwrap(), Arc::clone(&logger)));
 241
 242         let peers = RefCell::new([false; 256]);
 243         let mut loss_detector = MoneyLossDetector::new(&peers, channelmanager.clone(), monitor.clone(), PeerManager::new(MessageHandler {
 244                 chan_handler: channelmanager.clone(),
 245                 route_handler: router.clone(),
 246         }, our_network_key, Arc::clone(&logger)));
 247
 248         let mut should_forward = false;
 249         let mut payments_received: Vec<[u8; 32]> = Vec::new();
 250         let mut payments_sent = 0;
 251         let mut pending_funding_generation: Vec<([u8; 32], u64, Script)> = Vec::new();
 252         let mut pending_funding_signatures = HashMap::new();
 253         let mut pending_funding_relay = Vec::new();
 254
 255         loop {
 256                 match get_slice!(1)[0] {
 257                         0 => {
 258                                 let mut new_id = 0;
 259                                 for i in 1..256 {
 260                                         if !peers.borrow()[i-1] {
 261                                                 new_id = i;
 262                                                 break;
 263                                         }
 264                                 }
 265                                 if new_id == 0 { return; }
 266                                 loss_detector.handler.new_outbound_connection(get_pubkey!(), Peer{id: (new_id - 1) as u8, peers_connected: &peers}).unwrap();
 267                                 peers.borrow_mut()[new_id - 1] = true;
 268                         },
 269                         1 => {
 270                                 let mut new_id = 0;
 271                                 for i in 1..256 {
 272                                         if !peers.borrow()[i-1] {
 273                                                 new_id = i;
 274                                                 break;
 275                                         }
 276                                 }
 277                                 if new_id == 0 { return; }
 278                                 loss_detector.handler.new_inbound_connection(Peer{id: (new_id - 1) as u8, peers_connected: &peers}).unwrap();
 279                                 peers.borrow_mut()[new_id - 1] = true;
 280                         },
 281                         2 => {
 282                                 let peer_id = get_slice!(1)[0];
 283                                 if !peers.borrow()[peer_id as usize] { return; }
 284                                 loss_detector.handler.disconnect_event(&Peer{id: peer_id, peers_connected: &peers});
 285                                 peers.borrow_mut()[peer_id as usize] = false;
 286                         },
 287                         3 => {
 288                                 let peer_id = get_slice!(1)[0];
 289                                 if !peers.borrow()[peer_id as usize] { return; }
 290                                 match loss_detector.handler.read_event(&mut Peer{id: peer_id, peers_connected: &peers}, get_slice!(get_slice!(1)[0]).to_vec()) {
 291                                         Ok(res) => assert!(!res),
 292                                         Err(_) => { peers.borrow_mut()[peer_id as usize] = false; }
 293                                 }
 294                         },
 295                         4 => {
 296                                 let value = slice_to_be24(get_slice!(3)) as u64;
 297                                 let route = match router.get_route(&get_pubkey!(), None, &Vec::new(), value, 42) {
 298                                         Ok(route) => route,
 299                                         Err(_) => return,
 300                                 };
 301                                 let mut payment_hash = [0; 32];
 302                                 payment_hash[0..8].copy_from_slice(&be64_to_array(payments_sent));
 303                                 let mut sha = Sha256::new();
 304                                 sha.input(&payment_hash);
 305                                 sha.result(&mut payment_hash);
 306                                 payments_sent += 1;
 307                                 match channelmanager.send_payment(route, payment_hash) {
 308                                         Ok(_) => {},
 309                                         Err(_) => return,
 310                                 }
 311                         },
 312                         5 => {
 313                                 let peer_id = get_slice!(1)[0];
 314                                 if !peers.borrow()[peer_id as usize] { return; }
 315                                 let their_key = get_pubkey!();
 316                                 let chan_value = slice_to_be24(get_slice!(3)) as u64;
 317                                 //let push_msat_value = slice_to_be24(get_slice!(3)) as u64;
 318                                 // Temporarily don't read extra bytes to avoid breaking existing test-cases
 319                                 let push_msat_value = 0;
 320                                 if channelmanager.create_channel(their_key, chan_value, push_msat_value, 0).is_err() { return; }
 321                         },
 322                         6 => {
 323                                 let mut channels = channelmanager.list_channels();
 324                                 let channel_id = get_slice!(1)[0] as usize;
 325                                 if channel_id >= channels.len() { return; }
 326                                 channels.sort_by(|a, b| { a.channel_id.cmp(&b.channel_id) });
 327                                 if channelmanager.close_channel(&channels[channel_id].channel_id).is_err() { return; }
 328                         },
 329                         7 => {
 330                                 if should_forward {
 331                                         channelmanager.process_pending_htlc_forwards();
 332                                         should_forward = false;
 333                                 }
 334                         },
 335                         8 => {
 336                                 for payment in payments_received.drain(..) {
 337                                         // SHA256 is defined as XOR of all input bytes placed in the first byte, and 0s
 338                                         // for the remaining bytes. Thus, if not all remaining bytes are 0s we cannot
 339                                         // fulfill this HTLC, but if they are, we can just take the first byte and
 340                                         // place that anywhere in our preimage.
 341                                         if &payment[1..] != &[0; 31] {
 342                                                 channelmanager.fail_htlc_backwards(&payment);
 343                                         } else {
 344                                                 let mut payment_preimage = [0; 32];
 345                                                 payment_preimage[0] = payment[0];
 346                                                 channelmanager.claim_funds(payment_preimage);
 347                                         }
 348                                 }
 349                         },
 350                         9 => {
 351                                 for payment in payments_received.drain(..) {
 352                                         channelmanager.fail_htlc_backwards(&payment);
 353                                 }
 354                         },
 355                         10 => {
 356                                 for funding_generation in pending_funding_generation.drain(..) {
 357                                         let mut tx = Transaction { version: 0, lock_time: 0, input: Vec::new(), output: vec![TxOut {
 358                                                         value: funding_generation.1, script_pubkey: funding_generation.2,
 359                                                 }] };
 360                                         let funding_output = OutPoint::new(Sha256dHash::from_data(&serialize(&tx).unwrap()[..]), 0);
 361                                         let mut found_duplicate_txo = false;
 362                                         for chan in channelmanager.list_channels() {
 363                                                 if chan.channel_id == funding_output.to_channel_id() {
 364                                                         found_duplicate_txo = true;
 365                                                 }
 366                                         }
 367                                         if !found_duplicate_txo {
 368                                                 channelmanager.funding_transaction_generated(&funding_generation.0, funding_output.clone());
 369                                                 pending_funding_signatures.insert(funding_output, tx);
 370                                         }
 371                                 }
 372                         },
 373                         11 => {
 374                                 if !pending_funding_relay.is_empty() {
 375                                         let mut txn = Vec::with_capacity(pending_funding_relay.len());
 376                                         let mut txn_idxs = Vec::with_capacity(pending_funding_relay.len());
 377                                         for (idx, tx) in pending_funding_relay.iter().enumerate() {
 378                                                 txn.push(tx);
 379                                                 txn_idxs.push(idx as u32 + 1);
 380                                         }
 381
 382                                         loss_detector.connect_block(&txn[..], &txn_idxs[..]);
 383                                         txn_idxs.clear();
 384                                         for _ in 2..100 {
 385                                                 loss_detector.connect_block(&txn[..], &txn_idxs[..]);
 386                                         }
 387                                 }
 388                                 for tx in pending_funding_relay.drain(..) {
 389                                         loss_detector.funding_txn.push(tx);
 390                                 }
 391                         },
 392                         12 => {
 393                                 let txlen = slice_to_be16(get_slice!(2));
 394                                 if txlen == 0 {
 395                                         loss_detector.connect_block(&[], &[]);
 396                                 } else {
 397                                         let txres: Result<Transaction, _> = deserialize(get_slice!(txlen));
 398                                         if let Ok(tx) = txres {
 399                                                 loss_detector.connect_block(&[&tx], &[1]);
 400                                         } else {
 401                                                 return;
 402                                         }
 403                                 }
 404                         },
 405                         13 => {
 406                                 loss_detector.disconnect_block();
 407                         },
 408                         _ => return,
 409                 }
 410                 loss_detector.handler.process_events();
 411                 for event in loss_detector.handler.get_and_clear_pending_events() {
 412                         match event {
 413                                 Event::FundingGenerationReady { temporary_channel_id, channel_value_satoshis, output_script, .. } => {
 414                                         pending_funding_generation.push((temporary_channel_id, channel_value_satoshis, output_script));
 415                                 },
 416                                 Event::FundingBroadcastSafe { funding_txo, .. } => {
 417                                         pending_funding_relay.push(pending_funding_signatures.remove(&funding_txo).unwrap());
 418                                 },
 419                                 Event::PaymentReceived { payment_hash, .. } => {
 420                                         payments_received.push(payment_hash);
 421                                 },
 422                                 Event::PaymentSent {..} => {},
 423                                 Event::PaymentFailed {..} => {},
 424
 425                                 Event::PendingHTLCsForwardable {..} => {
 426                                         should_forward = true;
 427                                 },
 428                                 _ => panic!("Unknown event"),
 429                         }
 430                 }
 431         }
 432 }
 433
 434 #[cfg(feature = "afl")]
 435 #[macro_use] extern crate afl;
 436 #[cfg(feature = "afl")]
 437 fn main() {
 438         fuzz!(|data| {
 439                 let logger: Arc<Logger> = Arc::new(test_logger::TestLogger{});
 440                 do_test(data, &logger);
 441         });
 442 }
 443
 444 #[cfg(feature = "honggfuzz")]
 445 #[macro_use] extern crate honggfuzz;
 446 #[cfg(feature = "honggfuzz")]
 447 fn main() {
 448         loop {
 449                 fuzz!(|data| {
 450                         let logger: Arc<Logger> = Arc::new(test_logger::TestLogger{});
 451                         do_test(data, &logger);
 452                 });
 453         }
 454 }
 455
 456 extern crate hex;
 457 #[cfg(test)]
 458 mod tests {
 459         use utils::test_logger;
 460         use lightning::util::logger::{Logger, Record};
 461         use std::collections::HashMap;
 462         use std::sync::{Arc, Mutex};
 463
 464         #[test]
 465         fn duplicate_crash() {
 466                 let logger: Arc<Logger> = Arc::new(test_logger::TestLogger{});
 467                 super::do_test(&::hex::decode("00").unwrap(), &logger);
 468         }
 469
 470         struct TrackingLogger {
 471                 /// (module, message) -> count
 472                 pub lines: Mutex<HashMap<(String, String), usize>>,
 473         }
 474         impl Logger for TrackingLogger {
 475                 fn log(&self, record: &Record) {
 476                         *self.lines.lock().unwrap().entry((record.module_path.to_string(), format!("{}", record.args))).or_insert(0) += 1;
 477                         println!("{:<5} [{} : {}, {}] {}", record.level.to_string(), record.module_path, record.file, record.line, record.args);
 478                 }
 479         }
 480
 481         #[test]
 482         fn test_no_existing_test_breakage() {
 483                 // To avoid accidentally causing all existing fuzz test cases to be useless by making minor
 484                 // changes (such as requesting feerate info in a new place), we run a pretty full
 485                 // step-through with two peers and HTLC forwarding here. Obviously this is pretty finicky,
 486                 // so this should be updated pretty liberally, but at least we'll know when changes occur.
 487                 // If nothing else, this test serves as a pretty great initial full_stack_target seed.
 488
 489                 // What each byte represents is broken down below, and then everything is concatenated into
 490                 // one large test at the end (you want %s/ -.*//g %s/\n\| \|\t\|\///g).
 491
 492                 // 0000000000000000000000000000000000000000000000000000000000000000 - our network key
 493                 // 00000000 - fee_proportional_millionths
 494                 // 01 - announce_channels_publicly
 495                 //
 496                 // 00 - new outbound connection with id 0
 497                 // 030000000000000000000000000000000000000000000000000000000000000000 - peer's pubkey
 498                 // 030032 - inbound read from peer id 0 of len 50
 499                 // 00 030000000000000000000000000000000000000000000000000000000000000000 03000000000000000000000000000000 - noise act two (0||pubkey||mac)
 500                 //
 501                 // 030012 - inbound read from peer id 0 of len 18
 502                 // 0006 03000000000000000000000000000000 - message header indicating message length 6
 503                 // 030016 - inbound read from peer id 0 of len 22
 504                 // 0010 00000000 03000000000000000000000000000000 - init message with no features (type 16)
 505                 //
 506                 // 030012 - inbound read from peer id 0 of len 18
 507                 // 0141 03000000000000000000000000000000 - message header indicating message length 321
 508                 // 0300ff - inbound read from peer id 0 of len 255
 509                 // 0020 7500000000000000000000000000000000000000000000000000000000000000ff4f00f805273c1b203bb5ebf8436bfde57b3be8c2f5e95d9491dbb181909679000000000000c35000000000000000000000000000000222ffffffffffffffff00000000000002220000000000000000000000fd000601e303000000000000000000000000000000000000000000000000000000000000000103000000000000000000000000000000000000000000000000000000000000000203000000000000000000000000000000000000000000000000000000000000000303000000000000000000000000000000000000000000000000000000000000000403 - beginning of open_channel message
 510                 // 030052 - inbound read from peer id 0 of len 82
 511                 // 0000000000000000000000000000000000000000000000000000000000000005 030100000000000000000000000000000000000000000000000000000000000000 01 03000000000000000000000000000000 - rest of open_channel and mac
 512                 //
 513                 // 00fd00fd00fd - Three feerate requests (all returning min feerate, which our open_channel also uses)
 514                 // - client should now respond with accept_channel (CHECK 1: type 33 to peer 03000000)
 515                 //
 516                 // 030012 - inbound read from peer id 0 of len 18
 517                 // 0084 03000000000000000000000000000000 - message header indicating message length 132
 518                 // 030094 - inbound read from peer id 0 of len 148
 519                 // 0022 ff4f00f805273c1b203bb5ebf8436bfde57b3be8c2f5e95d9491dbb1819096793d00000000000000000000000000000000000000000000000000000000000000000036000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000001 03000000000000000000000000000000 - funding_created and mac
 520                 // - client should now respond with funding_signed (CHECK 2: type 35 to peer 03000000)
 521                 //
 522                 // 0c005e - connect a block with one transaction of len 94
 523                 // 020000000100000000000000000000000000000000000000000000000000000000000000000000000000ffffffff0150c3000000000000220020ae0000000000000000000000000000000000000000000000000000000000000000000000 - the funding transaction
 524                 // 0c0000 - connect a block with no transactions
 525                 // 0c0000 - connect a block with no transactions
 526                 // 0c0000 - connect a block with no transactions
 527                 // 0c0000 - connect a block with no transactions
 528                 // 0c0000 - connect a block with no transactions
 529                 // 0c0000 - connect a block with no transactions
 530                 // 0c0000 - connect a block with no transactions
 531                 // 0c0000 - connect a block with no transactions
 532                 // 0c0000 - connect a block with no transactions
 533                 // 0c0000 - connect a block with no transactions
 534                 // 0c0000 - connect a block with no transactions
 535                 // 0c0000 - connect a block with no transactions
 536                 // - by now client should have sent a funding_locked (CHECK 3: SendFundingLocked to 03000000 for chan 3d000000)
 537                 //
 538                 // 030012 - inbound read from peer id 0 of len 18
 539                 // 0043 03000000000000000000000000000000 - message header indicating message length 67
 540                 // 030053 - inbound read from peer id 0 of len 83
 541                 // 0024 3d00000000000000000000000000000000000000000000000000000000000000 030000000000000000000000000000000000000000000000000000000000000000 03000000000000000000000000000000 - funding_locked and mac
 542                 //
 543                 // 01 - new inbound connection with id 1
 544                 // 030132 - inbound read from peer id 1 of len 50
 545                 // 0003000000000000000000000000000000000000000000000000000000000000000003000000000000000000000000000000 - inbound noise act 1
 546                 // 030142 - inbound read from peer id 1 of len 66
 547                 // 000302000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000003000000000000000000000000000000 - inbound noise act 3
 548                 //
 549                 // 030112 - inbound read from peer id 1 of len 18
 550                 // 0006 01000000000000000000000000000000 - message header indicating message length 6
 551                 // 030116 - inbound read from peer id 1 of len 22
 552                 // 0010 00000000 01000000000000000000000000000000 - init message with no features (type 16)
 553                 //
 554                 // 050103020000000000000000000000000000000000000000000000000000000000000000c350 - create outbound channel to peer 1 for 50k sat
 555                 // 00fd00fd00fd - Three feerate requests (all returning min feerate)
 556                 //
 557                 // 030112 - inbound read from peer id 1 of len 18
 558                 // 0110 01000000000000000000000000000000 - message header indicating message length 272
 559                 // 0301ff - inbound read from peer id 1 of len 255
 560                 // 0021 0200000000000000020000000000000002000000000000000200000000000000000000000000001a00000000004c4b4000000000000003e800000000000003e80000000203f0000503000000000000000000000000000000000000000000000000000000000000010003000000000000000000000000000000000000000000000000000000000000020003000000000000000000000000000000000000000000000000000000000000030003000000000000000000000000000000000000000000000000000000000000040003000000000000000000000000000000000000000000000000000000000000050003000000000000000000000000000000 - beginning of accept_channel
 561                 // 030121 - inbound read from peer id 1 of len 33
 562                 // 0000000000000000000000000000000000 01000000000000000000000000000000 - rest of accept_channel and mac
 563                 //
 564                 // 0a - create the funding transaction (client should send funding_created now)
 565                 //
 566                 // 030112 - inbound read from peer id 1 of len 18
 567                 // 0062 01000000000000000000000000000000 - message header indicating message length 98
 568                 // 030172 - inbound read from peer id 1 of len 114
 569                 // 0023 3f00000000000000000000000000000000000000000000000000000000000000f7000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100 01000000000000000000000000000000 - funding_signed message and mac
 570                 //
 571                 // 0b - broadcast funding transaction
 572                 // - by now client should have sent a funding_locked (CHECK 4: SendFundingLocked to 03020000 for chan 3f000000)
 573                 //
 574                 // 030112 - inbound read from peer id 1 of len 18
 575                 // 0043 01000000000000000000000000000000 - message header indicating message length 67
 576                 // 030153 - inbound read from peer id 1 of len 83
 577                 // 0024 3f00000000000000000000000000000000000000000000000000000000000000 030100777777777777777777777777777777777777777777777777777777777777 01000000000000000000000000000000 - funding_locked and mac
 578                 //
 579                 // 030012 - inbound read from peer id 0 of len 18
 580                 // 05ac 03000000000000000000000000000000 - message header indicating message length 1452
 581                 // 0300ff - inbound read from peer id 0 of len 255
 582                 // 0080 3d00000000000000000000000000000000000000000000000000000000000000 0000000000000000 00000000000003e8 ff00000000000000000000000000000000000000000000000000000000000000 00000001 00 030000000000000000000000000000000000000000000000000000000000000555 0000000e000001000000000000000003e8000000010000000000000000000000000a00000000000000000000000000000000000000000000000000000000000000 ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff - beginning of update_add_htlc from 0 to 1 via client
 583                 // 0300ff - inbound read from peer id 0 of len 255
 584                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 585                 // 0300ff - inbound read from peer id 0 of len 255
 586                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 587                 // 0300ff - inbound read from peer id 0 of len 255
 588                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 589                 // 0300ff - inbound read from peer id 0 of len 255
 590                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 591                 // 0300c1 - inbound read from peer id 0 of len 193
 592                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff ef00000000000000000000000000000000000000000000000000000000000000 03000000000000000000000000000000 - end of update_add_htlc from 0 to 1 via client and mac
 593                 //
 594                 // 030012 - inbound read from peer id 0 of len 18
 595                 // 0064 03000000000000000000000000000000 - message header indicating message length 100
 596                 // 030074 - inbound read from peer id 0 of len 116
 597                 // 0084 3d00000000000000000000000000000000000000000000000000000000000000 36000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000001 0000 03000000000000000000000000000000 - commitment_signed and mac
 598                 // - client should now respond with revoke_and_ack and commitment_signed (CHECK 5/6: types 133 and 132 to peer 03000000)
 599                 //
 600                 // 030012 - inbound read from peer id 0 of len 18
 601                 // 0063 03000000000000000000000000000000 - message header indicating message length 99
 602                 // 030073 - inbound read from peer id 0 of len 115
 603                 // 0085 3d00000000000000000000000000000000000000000000000000000000000000 0100000000000000000000000000000000000000000000000000000000000000 031111111111111111111111111111111111111111111111111111111111111111 03000000000000000000000000000000 - revoke_and_ack and mac
 604                 //
 605                 // 07 - process the now-pending HTLC forward
 606                 // - client now sends id 1 update_add_htlc and commitment_signed (CHECK 7: SendHTLCs event for node 03020000 with 1 HTLCs for channel 3f000000)
 607                 //
 608                 // - we respond with commitment_signed then revoke_and_ack (a weird, but valid, order)
 609                 // 030112 - inbound read from peer id 1 of len 18
 610                 // 0064 01000000000000000000000000000000 - message header indicating message length 100
 611                 // 030174 - inbound read from peer id 1 of len 116
 612                 // 0084 3f00000000000000000000000000000000000000000000000000000000000000 f6000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100 0000 01000000000000000000000000000000 - commitment_signed and mac
 613                 //
 614                 // 030112 - inbound read from peer id 1 of len 18
 615                 // 0063 01000000000000000000000000000000 - message header indicating message length 99
 616                 // 030173 - inbound read from peer id 1 of len 115
 617                 // 0085 3f00000000000000000000000000000000000000000000000000000000000000 0000000000000000000000000000000000000000000000000000000000000000 032222222222222222222222222222222222222222222222222222222222222222 01000000000000000000000000000000 - revoke_and_ack and mac
 618                 //
 619                 // 030112 - inbound read from peer id 1 of len 18
 620                 // 004a 01000000000000000000000000000000 - message header indicating message length 74
 621                 // 03015a - inbound read from peer id 1 of len 90
 622                 // 0082 3f00000000000000000000000000000000000000000000000000000000000000 0000000000000000 ff00888888888888888888888888888888888888888888888888888888888888 01000000000000000000000000000000 - update_fulfill_htlc and mac
 623                 // - client should immediately claim the pending HTLC from peer 0 (CHECK 8: SendFulfillHTLCs for node 03000000 with preimage ff00888888 for channel 3d000000)
 624                 //
 625                 // 030112 - inbound read from peer id 1 of len 18
 626                 // 0064 01000000000000000000000000000000 - message header indicating message length 100
 627                 // 030174 - inbound read from peer id 1 of len 116
 628                 // 0084 3f00000000000000000000000000000000000000000000000000000000000000 f4000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100 0000 01000000000000000000000000000000 - commitment_signed and mac
 629                 //
 630                 // 030112 - inbound read from peer id 1 of len 18
 631                 // 0063 01000000000000000000000000000000 - message header indicating message length 99
 632                 // 030173 - inbound read from peer id 1 of len 115
 633                 // 0085 3f00000000000000000000000000000000000000000000000000000000000000 0100777777777777777777777777777777777777777777777777777777777777 033333333333333333333333333333333333333333333333333333333333333333 01000000000000000000000000000000 - revoke_and_ack and mac
 634                 //
 635                 // - before responding to the commitment_signed generated above, send a new HTLC
 636                 // 030012 - inbound read from peer id 0 of len 18
 637                 // 05ac 03000000000000000000000000000000 - message header indicating message length 1452
 638                 // 0300ff - inbound read from peer id 0 of len 255
 639                 // 0080 3d00000000000000000000000000000000000000000000000000000000000000 0000000000000001 00000000000003e8 ff00000000000000000000000000000000000000000000000000000000000000 00000001 00 030000000000000000000000000000000000000000000000000000000000000555 0000000e000001000000000000000003e8000000010000000000000000000000000a00000000000000000000000000000000000000000000000000000000000000 ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff - beginning of update_add_htlc from 0 to 1 via client
 640                 // 0300ff - inbound read from peer id 0 of len 255
 641                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 642                 // 0300ff - inbound read from peer id 0 of len 255
 643                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 644                 // 0300ff - inbound read from peer id 0 of len 255
 645                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 646                 // 0300ff - inbound read from peer id 0 of len 255
 647                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff
 648                 // 0300c1 - inbound read from peer id 0 of len 193
 649                 // ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff ef00000000000000000000000000000000000000000000000000000000000000 03000000000000000000000000000000 - end of update_add_htlc from 0 to 1 via client and mac
 650                 //
 651                 // - now respond to the update_fulfill_htlc+commitment_signed messages the client sent to peer 0
 652                 // 030012 - inbound read from peer id 0 of len 18
 653                 // 0063 03000000000000000000000000000000 - message header indicating message length 99
 654                 // 030073 - inbound read from peer id 0 of len 115
 655                 // 0085 3d00000000000000000000000000000000000000000000000000000000000000 0000000000000000000000000000000000000000000000000000000000000000 034444444444444444444444444444444444444444444444444444444444444444 03000000000000000000000000000000 - revoke_and_ack and mac
 656                 // - client should now respond with revoke_and_ack and commitment_signed (CHECK 5/6)
 657                 // duplicates)
 658                 //
 659                 // 030012 - inbound read from peer id 0 of len 18
 660                 // 0064 03000000000000000000000000000000 - message header indicating message length 100
 661                 // 030074 - inbound read from peer id 0 of len 116
 662                 // 0084 3d00000000000000000000000000000000000000000000000000000000000000 3a000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000001 0000 03000000000000000000000000000000 - commitment_signed and mac
 663                 //
 664                 // 030012 - inbound read from peer id 0 of len 18
 665                 // 0063 03000000000000000000000000000000 - message header indicating message length 99
 666                 // 030073 - inbound read from peer id 0 of len 115
 667                 // 0085 3d00000000000000000000000000000000000000000000000000000000000000 1111111111111111111111111111111111111111111111111111111111111111035555555555555555555555555555555555555555555555555555555555555555 03000000000000000000000000000000 - revoke_and_ack and mac
 668                 //
 669                 // 07 - process the now-pending HTLC forward
 670                 // - client now sends id 1 update_add_htlc and commitment_signed (CHECK 7 duplicate)
 671                 // - we respond with revoke_and_ack, then commitment_signed, then update_fail_htlc
 672                 //
 673                 // 030112 - inbound read from peer id 1 of len 18
 674                 // 0064 01000000000000000000000000000000 - message header indicating message length 100
 675                 // 030174 - inbound read from peer id 1 of len 116
 676                 // 0084 3f00000000000000000000000000000000000000000000000000000000000000 f5000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100 0000 01000000000000000000000000000000 - commitment_signed and mac
 677                 //
 678                 // 030112 - inbound read from peer id 1 of len 18
 679                 // 0063 01000000000000000000000000000000 - message header indicating message length 99
 680                 // 030173 - inbound read from peer id 1 of len 115
 681                 // 0085 3f00000000000000000000000000000000000000000000000000000000000000 2222222222222222222222222222222222222222222222222222222222222222 036666666666666666666666666666666666666666666666666666666666666666 01000000000000000000000000000000 - revoke_and_ack and mac
 682                 //
 683                 // 030112 - inbound read from peer id 1 of len 18
 684                 // 002c 01000000000000000000000000000000 - message header indicating message length 44
 685                 // 03013c - inbound read from peer id 1 of len 60
 686                 // 0083 3f00000000000000000000000000000000000000000000000000000000000000 0000000000000001 0000 01000000000000000000000000000000 - update_fail_htlc and mac
 687                 //
 688                 // 030112 - inbound read from peer id 1 of len 18
 689                 // 0064 01000000000000000000000000000000 - message header indicating message length 100
 690                 // 030174 - inbound read from peer id 1 of len 116
 691                 // 0084 3f00000000000000000000000000000000000000000000000000000000000000 f2000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100 0000 01000000000000000000000000000000 - commitment_signed and mac
 692                 //
 693                 // - TODO: update_fail_htlc from peer 1
 694
 695                 let logger = Arc::new(TrackingLogger { lines: Mutex::new(HashMap::new()) });
 696                 super::do_test(&::hex::decode("00000000000000000000000000000000000000000000000000000000000000000000000001000300000000000000000000000000000000000000000000000000000000000000000300320003000000000000000000000000000000000000000000000000000000000000000003000000000000000000000000000000030012000603000000000000000000000000000000030016001000000000030000000000000000000000000000000300120141030000000000000000000000000000000300ff00207500000000000000000000000000000000000000000000000000000000000000ff4f00f805273c1b203bb5ebf8436bfde57b3be8c2f5e95d9491dbb181909679000000000000c35000000000000000000000000000000222ffffffffffffffff00000000000002220000000000000000000000fd000601e3030000000000000000000000000000000000000000000000000000000000000001030000000000000000000000000000000000000000000000000000000000000002030000000000000000000000000000000000000000000000000000000000000003030000000000000000000000000000000000000000000000000000000000000004030300520000000000000000000000000000000000000000000000000000000000000005030100000000000000000000000000000000000000000000000000000000000000010300000000000000000000000000000000fd00fd00fd0300120084030000000000000000000000000000000300940022ff4f00f805273c1b203bb5ebf8436bfde57b3be8c2f5e95d9491dbb1819096793d00000000000000000000000000000000000000000000000000000000000000000036000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000001030000000000000000000000000000000c005e020000000100000000000000000000000000000000000000000000000000000000000000000000000000ffffffff0150c3000000000000220020ae00000000000000000000000000000000000000000000000000000000000000000000000c00000c00000c00000c00000c00000c00000c00000c00000c00000c00000c00000c000003001200430300000000000000000000000000000003005300243d000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000001030132000300000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000003014200030200000000000000000000000000000000000000000000000000000000000000030000000000000000000000000000000300000000000000000000000000000003011200060100000000000000000000000000000003011600100000000001000000000000000000000000000000050103020000000000000000000000000000000000000000000000000000000000000000c35000fd00fd00fd0301120110010000000000000000000000000000000301ff00210200000000000000020000000000000002000000000000000200000000000000000000000000001a00000000004c4b4000000000000003e800000000000003e80000000203f00005030000000000000000000000000000000000000000000000000000000000000100030000000000000000000000000000000000000000000000000000000000000200030000000000000000000000000000000000000000000000000000000000000300030000000000000000000000000000000000000000000000000000000000000400030000000000000000000000000000000000000000000000000000000000000500030000000000000000000000000000000301210000000000000000000000000000000000010000000000000000000000000000000a03011200620100000000000000000000000000000003017200233f00000000000000000000000000000000000000000000000000000000000000f7000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100010000000000000000000000000000000b03011200430100000000000000000000000000000003015300243f000000000000000000000000000000000000000000000000000000000000000301007777777777777777777777777777777777777777777777777777777777770100000000000000000000000000000003001205ac030000000000000000000000000000000300ff00803d00000000000000000000000000000000000000000000000000000000000000000000000000000000000000000003e8ff0000000000000000000000000000000000000000000000000000000000000000000001000300000000000000000000000000000000000000000000000000000000000005550000000e000001000000000000000003e8000000010000000000000000000000000a00000000000000000000000000000000000000000000000000000000000000ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300c1ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffef000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000003001200640300000000000000000000000000000003007400843d000000000000000000000000000000000000000000000000000000000000003600000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100000300000000000000000000000000000003001200630300000000000000000000000000000003007300853d000000000000000000000000000000000000000000000000000000000000000100000000000000000000000000000000000000000000000000000000000000031111111111111111111111111111111111111111111111111111111111111111030000000000000000000000000000000703011200640100000000000000000000000000000003017400843f00000000000000000000000000000000000000000000000000000000000000f600000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000010000000100000000000000000000000000000003011200630100000000000000000000000000000003017300853f00000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000003222222222222222222222222222222222222222222222222222222222222222201000000000000000000000000000000030112004a0100000000000000000000000000000003015a00823f000000000000000000000000000000000000000000000000000000000000000000000000000000ff008888888888888888888888888888888888888888888888888888888888880100000000000000000000000000000003011200640100000000000000000000000000000003017400843f00000000000000000000000000000000000000000000000000000000000000f400000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000010000000100000000000000000000000000000003011200630100000000000000000000000000000003017300853f0000000000000000000000000000000000000000000000000000000000000001007777777777777777777777777777777777777777777777777777777777770333333333333333333333333333333333333333333333333333333333333333330100000000000000000000000000000003001205ac030000000000000000000000000000000300ff00803d00000000000000000000000000000000000000000000000000000000000000000000000000000100000000000003e8ff0000000000000000000000000000000000000000000000000000000000000000000001000300000000000000000000000000000000000000000000000000000000000005550000000e000001000000000000000003e8000000010000000000000000000000000a00000000000000000000000000000000000000000000000000000000000000ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffff0300c1ffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffffef000000000000000000000000000000000000000000000000000000000000000300000000000000000000000000000003001200630300000000000000000000000000000003007300853d0000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000344444444444444444444444444444444444444444444444444444444444444440300000000000000000000000000000003001200640300000000000000000000000000000003007400843d000000000000000000000000000000000000000000000000000000000000003a00000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100000300000000000000000000000000000003001200630300000000000000000000000000000003007300853d000000000000000000000000000000000000000000000000000000000000001111111111111111111111111111111111111111111111111111111111111111035555555555555555555555555555555555555555555555555555555555555555030000000000000000000000000000000703011200640100000000000000000000000000000003017400843f00000000000000000000000000000000000000000000000000000000000000f500000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000010000000100000000000000000000000000000003011200630100000000000000000000000000000003017300853f00000000000000000000000000000000000000000000000000000000000000222222222222222222222222222222222222222222222222222222222222222203666666666666666666666666666666666666666666666666666666666666666601000000000000000000000000000000030112002c0100000000000000000000000000000003013c00833f00000000000000000000000000000000000000000000000000000000000000000000000000000100000100000000000000000000000000000003011200640100000000000000000000000000000003017400843f00000000000000000000000000000000000000000000000000000000000000f2000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000100000001000000000000000000000000000000").unwrap(), &(Arc::clone(&logger) as Arc<Logger>));
 697
 698                 let log_entries = logger.lines.lock().unwrap();
 699                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Encoding and sending message of type 33 to 030000000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&1)); // 1
 700                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Encoding and sending message of type 35 to 030000000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&1)); // 2
 701                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Handling SendFundingLocked event in peer_handler for node 030000000000000000000000000000000000000000000000000000000000000000 for channel 3d00000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&1)); // 3
 702                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Handling SendFundingLocked event in peer_handler for node 030200000000000000000000000000000000000000000000000000000000000000 for channel 3f00000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&1)); // 4
 703                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Encoding and sending message of type 133 to 030000000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&2)); // 5
 704                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Encoding and sending message of type 132 to 030000000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&2)); // 6
 705                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Handling SendHTLCs event in peer_handler for node 030200000000000000000000000000000000000000000000000000000000000000 with 1 HTLCs for channel 3f00000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&2)); // 7
 706                 assert_eq!(log_entries.get(&("lightning::ln::peer_handler".to_string(), "Handling SendFulfillHTLCs event in peer_handler for node 030000000000000000000000000000000000000000000000000000000000000000 with payment_preimage ff00888888888888888888888888888888888888888888888888888888888888 for channel 3d00000000000000000000000000000000000000000000000000000000000000".to_string())), Some(&1)); // 8
 707
 708         }
 709 }