builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-079 starttime: 1497629919.22 results: success (0) revision: 58c5151bfd62de934b2286dbd664e69886270e28 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.217436) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.217871) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.218160) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.237689) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.238061) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-06-16 09:18:39-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 39.4M=0s 2017-06-16 09:18:39 (39.4 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.074162 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.325113) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.325408) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019916 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:39.410591) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-06-16 09:18:39.410943) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 58c5151bfd62de934b2286dbd664e69886270e28 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 58c5151bfd62de934b2286dbd664e69886270e28 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-06-16 09:18:39,798 truncating revision to first 12 chars 2017-06-16 09:18:39,798 Setting DEBUG logging. 2017-06-16 09:18:39,798 attempt 1/10 2017-06-16 09:18:39,798 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/58c5151bfd62?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-06-16 09:18:40,827 unpacking tar archive at: mozilla-central-58c5151bfd62/testing/mozharness/ program finished with exit code 0 elapsedTime=1.402008 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-06-16 09:18:40.829296) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:40.829651) ========= script_repo_revision: 58c5151bfd62de934b2286dbd664e69886270e28 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:40.830047) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:40.830313) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-06-16 09:18:40.840454) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2017-06-16 09:18:40.840836) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:18:41 INFO - MultiFileLogger online at 20170616 09:18:41 in /builds/slave/test 09:18:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 09:18:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:18:41 INFO - {'append_to_log': False, 09:18:41 INFO - 'base_work_dir': '/builds/slave/test', 09:18:41 INFO - 'blob_upload_branch': 'Firefox', 09:18:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:18:41 INFO - 'branch': 'Firefox', 09:18:41 INFO - 'buildbot_json_path': 'buildprops.json', 09:18:41 INFO - 'config_files': ('talos/linux_config.py',), 09:18:41 INFO - 'default_actions': ('clobber', 09:18:41 INFO - 'read-buildbot-config', 09:18:41 INFO - 'download-and-extract', 09:18:41 INFO - 'populate-webroot', 09:18:41 INFO - 'create-virtualenv', 09:18:41 INFO - 'install', 09:18:41 INFO - 'setup-mitmproxy', 09:18:41 INFO - 'run-tests'), 09:18:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:18:41 INFO - 'download_minidump_stackwalk': True, 09:18:41 INFO - 'download_symbols': 'ondemand', 09:18:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:18:41 INFO - 'tooltool.py': '/tools/tooltool.py', 09:18:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:18:41 INFO - '/tools/misc-python/virtualenv.py')}, 09:18:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:18:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:18:41 INFO - 'gecko_profile': False, 09:18:41 INFO - 'gecko_profile_interval': 0, 09:18:41 INFO - 'installer_path': 'installer.exe', 09:18:41 INFO - 'log_level': 'info', 09:18:41 INFO - 'log_name': 'talos', 09:18:41 INFO - 'log_to_console': True, 09:18:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:18:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:18:41 INFO - 'opt_config_files': (), 09:18:41 INFO - 'pip_index': False, 09:18:41 INFO - 'suite': 'dromaeojs-e10s', 09:18:41 INFO - 'system_bits': '32', 09:18:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:18:41 INFO - 'title': 'talos-linux64-ix-079', 09:18:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:18:41 INFO - 'use_talos_json': True, 09:18:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:18:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:18:41 INFO - 'work_dir': 'build'} 09:18:41 INFO - [mozharness: 2017-06-16 16:18:41.325818Z] Running clobber step. 09:18:41 INFO - Running pre-action listener: _resource_record_pre_action 09:18:41 INFO - Running main action method: clobber 09:18:41 INFO - rmtree: /builds/slave/test/build 09:18:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:18:42 INFO - Running post-action listener: _resource_record_post_action 09:18:42 INFO - [mozharness: 2017-06-16 16:18:42.351076Z] Finished clobber step (success) 09:18:42 INFO - [mozharness: 2017-06-16 16:18:42.351175Z] Running read-buildbot-config step. 09:18:42 INFO - Running pre-action listener: _resource_record_pre_action 09:18:42 INFO - Running main action method: read_buildbot_config 09:18:42 INFO - Using buildbot properties: 09:18:42 INFO - { 09:18:42 INFO - "project": "", 09:18:42 INFO - "product": "firefox", 09:18:42 INFO - "who": "ffxbld@noreply.mozilla.org", 09:18:42 INFO - "installer_path": "public/build/target.tar.bz2", 09:18:42 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 09:18:42 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 09:18:42 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 09:18:42 INFO - "stage_platform": "linux64-stylo", 09:18:42 INFO - "basedir": "/builds/slave/test", 09:18:42 INFO - "buildnumber": 156, 09:18:42 INFO - "platform": "ubuntu64_hw_stylo", 09:18:42 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 09:18:42 INFO - "slavebuilddir": "test", 09:18:42 INFO - "taskId": "DDHgsV1SQp-ETJO9dcff1w", 09:18:42 INFO - "branch": "mozilla-central", 09:18:42 INFO - "script_repo_revision": "production", 09:18:42 INFO - "revision": "58c5151bfd62de934b2286dbd664e69886270e28", 09:18:42 INFO - "slavename": "talos-linux64-ix-079", 09:18:42 INFO - "repo_path": "mozilla-central" 09:18:42 INFO - } 09:18:42 INFO - Finding installer, test and symbols from parent task. 09:18:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DDHgsV1SQp-ETJO9dcff1w'}, attempt #1 09:18:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DDHgsV1SQp-ETJO9dcff1w'}, attempt #1 09:18:43 INFO - Task dependencies: PX2TKEAnQPGMbf97rs9W-w 09:18:43 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w'}, attempt #1 09:18:43 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 09:18:43 INFO - Set test_url: https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/test_packages.json 09:18:43 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.crashreporter-symbols.zip 09:18:43 INFO - Running post-action listener: _resource_record_post_action 09:18:43 INFO - [mozharness: 2017-06-16 16:18:43.700922Z] Finished read-buildbot-config step (success) 09:18:43 INFO - [mozharness: 2017-06-16 16:18:43.701140Z] Running download-and-extract step. 09:18:43 INFO - Running pre-action listener: _resource_record_pre_action 09:18:43 INFO - Running main action method: download_and_extract 09:18:43 INFO - mkdir: /builds/slave/test/build/tests 09:18:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:18:43 INFO - trying https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.test_packages.json 09:18:43 INFO - Downloading https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 09:18:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 09:18:44 INFO - Downloaded 989 bytes. 09:18:44 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 09:18:44 INFO - Using the following test package requirements: 09:18:44 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 09:18:44 INFO - u'common': [u'target.common.tests.zip'], 09:18:44 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 09:18:44 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 09:18:44 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 09:18:44 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 09:18:44 INFO - u'mozbase': [u'target.common.tests.zip'], 09:18:44 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 09:18:44 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 09:18:44 INFO - u'web-platform': [u'target.common.tests.zip', 09:18:44 INFO - u'target.web-platform.tests.tar.gz'], 09:18:44 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 09:18:44 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 09:18:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip 09:18:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:18:44 INFO - Fetch https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip into memory 09:18:45 INFO - Content-Length response header: 67978503 09:18:45 INFO - Bytes received: 67978503 09:18:56 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 09:18:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip 09:18:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:18:56 INFO - Fetch https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.common.tests.zip into memory 09:18:57 INFO - Content-Length response header: 67978503 09:18:57 INFO - Bytes received: 67978503 09:19:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.talos.tests.zip 09:19:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.talos.tests.zip'}, attempt #1 09:19:09 INFO - Fetch https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.talos.tests.zip into memory 09:19:10 INFO - Content-Length response header: 14454970 09:19:10 INFO - Bytes received: 14454970 09:19:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:10 INFO - trying https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 09:19:10 INFO - Downloading https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 09:19:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 09:19:12 INFO - Downloaded 61446172 bytes. 09:19:12 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 09:19:12 INFO - mkdir: /builds/slave/test/properties 09:19:12 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:19:12 INFO - Writing to file /builds/slave/test/properties/build_url 09:19:12 INFO - Contents: 09:19:12 INFO - build_url:https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 09:19:12 INFO - Running post-action listener: _resource_record_post_action 09:19:12 INFO - Running post-action listener: set_extra_try_arguments 09:19:12 INFO - [mozharness: 2017-06-16 16:19:12.737186Z] Finished download-and-extract step (success) 09:19:12 INFO - [mozharness: 2017-06-16 16:19:12.737347Z] Running populate-webroot step. 09:19:12 INFO - Running pre-action listener: _resource_record_pre_action 09:19:12 INFO - Running main action method: populate_webroot 09:19:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:19:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:19:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:19:12 INFO - '--tppagecycles', 09:19:12 INFO - '7'], 09:19:12 INFO - 'tests': ['tsvgm']}}, 09:19:12 INFO - 'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:19:12 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:19:12 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:19:12 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:19:12 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:19:12 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['damp', 'tps']}, 09:19:12 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'tests': ['damp', 'tps']}, 09:19:12 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['dromaeo_dom']}, 09:19:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:19:12 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 09:19:12 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 09:19:12 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 09:19:12 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'other-e10s': {'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['a11yr', 09:19:12 INFO - 'ts_paint', 09:19:12 INFO - 'tpaint', 09:19:12 INFO - 'sessionrestore', 09:19:12 INFO - 'sessionrestore_no_auto_restore', 09:19:12 INFO - 'tabpaint']}, 09:19:12 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 09:19:12 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 09:19:12 INFO - 'bloom_basic_ref']}, 09:19:12 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 09:19:12 INFO - 'talos_options': ['--mitmproxy', 09:19:12 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 09:19:12 INFO - '--firstNonBlankPaint'], 09:19:12 INFO - 'tests': ['quantum_pageload_google', 09:19:12 INFO - 'quantum_pageload_youtube', 09:19:12 INFO - 'quantum_pageload_amazon', 09:19:12 INFO - 'quantum_pageload_facebook']}, 09:19:12 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['tsvgx', 09:19:12 INFO - 'tsvgr_opacity', 09:19:12 INFO - 'tart', 09:19:12 INFO - 'tscrollx', 09:19:12 INFO - 'cart', 09:19:12 INFO - 'tsvg_static']}, 09:19:12 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:19:12 INFO - 'tsvgr_opacity', 09:19:12 INFO - 'tart', 09:19:12 INFO - 'tscrollx', 09:19:12 INFO - 'cart', 09:19:12 INFO - 'tsvg_static']}, 09:19:12 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'talos_options': ['--disable-e10s'], 09:19:12 INFO - 'tests': ['tp5o']}, 09:19:12 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 09:19:12 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'talos_options': ['--disable-e10s', 09:19:12 INFO - '--xperf_path', 09:19:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:19:12 INFO - 'tests': ['tp5n']}, 09:19:12 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 09:19:12 INFO - 'talos_options': ['--xperf_path', 09:19:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:19:12 INFO - 'tests': ['tp5n']}}, 09:19:12 INFO - 'talos.zip': {'path': '', 09:19:12 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:19:12 INFO - Running post-action listener: _resource_record_post_action 09:19:12 INFO - [mozharness: 2017-06-16 16:19:12.758119Z] Finished populate-webroot step (success) 09:19:12 INFO - [mozharness: 2017-06-16 16:19:12.758209Z] Running create-virtualenv step. 09:19:12 INFO - Running pre-action listener: _resource_record_pre_action 09:19:12 INFO - Running main action method: create_virtualenv 09:19:12 INFO - Creating virtualenv /builds/slave/test/build/venv 09:19:12 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 09:19:12 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:19:12 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 09:19:12 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:19:12 INFO - Using real prefix '/usr' 09:19:12 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:19:13 INFO - Installing distribute.............................................................................................................................................................................................done. 09:19:15 INFO - Installing pip.................done. 09:19:15 INFO - Return code: 0 09:19:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:19:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:19:15 INFO - Reading from file tmpfile_stdout 09:19:15 INFO - Output received: 09:19:15 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 09:19:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 09:19:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 09:19:15 INFO - Using env: {'DISPLAY': ':0', 09:19:15 INFO - 'HOME': '/home/cltbld', 09:19:15 INFO - 'LANG': 'en_US.UTF-8', 09:19:15 INFO - 'LANGUAGE': 'en_US:en', 09:19:15 INFO - 'LOGNAME': 'cltbld', 09:19:15 INFO - 'MAIL': '/var/mail/cltbld', 09:19:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:15 INFO - 'MOZ_NO_REMOTE': '1', 09:19:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:15 INFO - 'NO_EM_RESTART': '1', 09:19:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:15 INFO - 'PWD': '/builds/slave/test', 09:19:15 INFO - 'SHELL': '/bin/bash', 09:19:15 INFO - 'SHLVL': '1', 09:19:15 INFO - 'TERM': 'linux', 09:19:15 INFO - 'TMOUT': '86400', 09:19:15 INFO - 'USER': 'cltbld', 09:19:15 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:15 INFO - '_': '/tools/buildbot/bin/python'} 09:19:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:15 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 09:19:15 INFO - Cleaning up... 09:19:15 INFO - Return code: 0 09:19:15 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 09:19:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 09:19:15 INFO - Using env: {'DISPLAY': ':0', 09:19:15 INFO - 'HOME': '/home/cltbld', 09:19:15 INFO - 'LANG': 'en_US.UTF-8', 09:19:15 INFO - 'LANGUAGE': 'en_US:en', 09:19:15 INFO - 'LOGNAME': 'cltbld', 09:19:15 INFO - 'MAIL': '/var/mail/cltbld', 09:19:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:15 INFO - 'MOZ_NO_REMOTE': '1', 09:19:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:15 INFO - 'NO_EM_RESTART': '1', 09:19:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:15 INFO - 'PWD': '/builds/slave/test', 09:19:15 INFO - 'SHELL': '/bin/bash', 09:19:15 INFO - 'SHLVL': '1', 09:19:15 INFO - 'TERM': 'linux', 09:19:15 INFO - 'TMOUT': '86400', 09:19:15 INFO - 'USER': 'cltbld', 09:19:15 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:15 INFO - '_': '/tools/buildbot/bin/python'} 09:19:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:15 INFO - Downloading/unpacking psutil>=3.1.1 09:19:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:19:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:19:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:19:17 INFO - Installing collected packages: psutil 09:19:17 INFO - Running setup.py install for psutil 09:19:17 INFO - building 'psutil._psutil_linux' extension 09:19:17 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 09:19:17 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 09:19:17 INFO - building 'psutil._psutil_posix' extension 09:19:17 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 09:19:17 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 09:19:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:19:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:19:17 INFO - Successfully installed psutil 09:19:17 INFO - Cleaning up... 09:19:17 INFO - Return code: 0 09:19:17 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:19:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 09:19:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 09:19:17 INFO - Using env: {'DISPLAY': ':0', 09:19:17 INFO - 'HOME': '/home/cltbld', 09:19:17 INFO - 'LANG': 'en_US.UTF-8', 09:19:17 INFO - 'LANGUAGE': 'en_US:en', 09:19:17 INFO - 'LOGNAME': 'cltbld', 09:19:17 INFO - 'MAIL': '/var/mail/cltbld', 09:19:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:17 INFO - 'MOZ_NO_REMOTE': '1', 09:19:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:17 INFO - 'NO_EM_RESTART': '1', 09:19:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:17 INFO - 'PWD': '/builds/slave/test', 09:19:17 INFO - 'SHELL': '/bin/bash', 09:19:17 INFO - 'SHLVL': '1', 09:19:17 INFO - 'TERM': 'linux', 09:19:17 INFO - 'TMOUT': '86400', 09:19:17 INFO - 'USER': 'cltbld', 09:19:17 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:17 INFO - '_': '/tools/buildbot/bin/python'} 09:19:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:17 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:19:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:19 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:19:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:19:19 INFO - Installing collected packages: mozsystemmonitor 09:19:19 INFO - Running setup.py install for mozsystemmonitor 09:19:19 INFO - Successfully installed mozsystemmonitor 09:19:19 INFO - Cleaning up... 09:19:19 INFO - Return code: 0 09:19:19 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:19:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 09:19:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:19:19 INFO - Using env: {'DISPLAY': ':0', 09:19:19 INFO - 'HOME': '/home/cltbld', 09:19:19 INFO - 'LANG': 'en_US.UTF-8', 09:19:19 INFO - 'LANGUAGE': 'en_US:en', 09:19:19 INFO - 'LOGNAME': 'cltbld', 09:19:19 INFO - 'MAIL': '/var/mail/cltbld', 09:19:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:19 INFO - 'MOZ_NO_REMOTE': '1', 09:19:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:19 INFO - 'NO_EM_RESTART': '1', 09:19:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:19 INFO - 'PWD': '/builds/slave/test', 09:19:19 INFO - 'SHELL': '/bin/bash', 09:19:19 INFO - 'SHLVL': '1', 09:19:19 INFO - 'TERM': 'linux', 09:19:19 INFO - 'TMOUT': '86400', 09:19:19 INFO - 'USER': 'cltbld', 09:19:19 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:19 INFO - '_': '/tools/buildbot/bin/python'} 09:19:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:19 INFO - Downloading/unpacking jsonschema==2.5.1 09:19:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:20 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:19:20 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:20 INFO - Downloading functools32-3.2.3-2.tar.gz 09:19:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:19:20 INFO - warning: no files found matching '*.txt' 09:19:20 INFO - no previously-included directories found matching 'build' 09:19:20 INFO - no previously-included directories found matching 'dist' 09:19:20 INFO - no previously-included directories found matching '.git*' 09:19:20 INFO - Installing collected packages: jsonschema, functools32 09:19:20 INFO - Running setup.py install for functools32 09:19:20 INFO - warning: no files found matching '*.txt' 09:19:20 INFO - no previously-included directories found matching 'build' 09:19:20 INFO - no previously-included directories found matching 'dist' 09:19:20 INFO - no previously-included directories found matching '.git*' 09:19:20 INFO - Successfully installed jsonschema functools32 09:19:20 INFO - Cleaning up... 09:19:20 INFO - Return code: 0 09:19:20 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:19:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 09:19:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 09:19:20 INFO - Using env: {'DISPLAY': ':0', 09:19:20 INFO - 'HOME': '/home/cltbld', 09:19:20 INFO - 'LANG': 'en_US.UTF-8', 09:19:20 INFO - 'LANGUAGE': 'en_US:en', 09:19:20 INFO - 'LOGNAME': 'cltbld', 09:19:20 INFO - 'MAIL': '/var/mail/cltbld', 09:19:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:20 INFO - 'MOZ_NO_REMOTE': '1', 09:19:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:20 INFO - 'NO_EM_RESTART': '1', 09:19:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:20 INFO - 'PWD': '/builds/slave/test', 09:19:20 INFO - 'SHELL': '/bin/bash', 09:19:20 INFO - 'SHLVL': '1', 09:19:20 INFO - 'TERM': 'linux', 09:19:20 INFO - 'TMOUT': '86400', 09:19:20 INFO - 'USER': 'cltbld', 09:19:20 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:20 INFO - '_': '/tools/buildbot/bin/python'} 09:19:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:21 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:19:21 INFO - Cleaning up... 09:19:21 INFO - Return code: 0 09:19:21 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:19:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 09:19:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:19:21 INFO - Using env: {'DISPLAY': ':0', 09:19:21 INFO - 'HOME': '/home/cltbld', 09:19:21 INFO - 'LANG': 'en_US.UTF-8', 09:19:21 INFO - 'LANGUAGE': 'en_US:en', 09:19:21 INFO - 'LOGNAME': 'cltbld', 09:19:21 INFO - 'MAIL': '/var/mail/cltbld', 09:19:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:21 INFO - 'MOZ_NO_REMOTE': '1', 09:19:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:21 INFO - 'NO_EM_RESTART': '1', 09:19:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:21 INFO - 'PWD': '/builds/slave/test', 09:19:21 INFO - 'SHELL': '/bin/bash', 09:19:21 INFO - 'SHLVL': '1', 09:19:21 INFO - 'TERM': 'linux', 09:19:21 INFO - 'TMOUT': '86400', 09:19:21 INFO - 'USER': 'cltbld', 09:19:21 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:21 INFO - '_': '/tools/buildbot/bin/python'} 09:19:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:21 INFO - Downloading/unpacking blobuploader==1.2.4 09:19:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:22 INFO - Downloading blobuploader-1.2.4.tar.gz 09:19:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:19:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:19:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:22 INFO - Downloading docopt-0.6.1.tar.gz 09:19:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:19:23 INFO - Installing collected packages: blobuploader, requests, docopt 09:19:23 INFO - Running setup.py install for blobuploader 09:19:23 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:19:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:19:23 INFO - Running setup.py install for requests 09:19:23 INFO - Running setup.py install for docopt 09:19:23 INFO - Successfully installed blobuploader requests docopt 09:19:23 INFO - Cleaning up... 09:19:23 INFO - Return code: 0 09:19:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:19:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 09:19:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:19:23 INFO - Using env: {'DISPLAY': ':0', 09:19:23 INFO - 'HOME': '/home/cltbld', 09:19:23 INFO - 'LANG': 'en_US.UTF-8', 09:19:23 INFO - 'LANGUAGE': 'en_US:en', 09:19:23 INFO - 'LOGNAME': 'cltbld', 09:19:23 INFO - 'MAIL': '/var/mail/cltbld', 09:19:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:23 INFO - 'MOZ_NO_REMOTE': '1', 09:19:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:23 INFO - 'NO_EM_RESTART': '1', 09:19:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:23 INFO - 'PWD': '/builds/slave/test', 09:19:23 INFO - 'SHELL': '/bin/bash', 09:19:23 INFO - 'SHLVL': '1', 09:19:23 INFO - 'TERM': 'linux', 09:19:23 INFO - 'TMOUT': '86400', 09:19:23 INFO - 'USER': 'cltbld', 09:19:23 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:23 INFO - '_': '/tools/buildbot/bin/python'} 09:19:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:19:23 INFO - Running setup.py (path:/tmp/pip-31EKLE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:19:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:19:23 INFO - Running setup.py (path:/tmp/pip-mI5TEl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:19:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:19:23 INFO - Running setup.py (path:/tmp/pip-LpxFZa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:19:24 INFO - Running setup.py (path:/tmp/pip-5wFM0c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:19:24 INFO - Running setup.py (path:/tmp/pip-aD66qA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:19:24 INFO - Running setup.py (path:/tmp/pip-G13ikW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:19:24 INFO - Running setup.py (path:/tmp/pip-M9BNIv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:19:24 INFO - Running setup.py (path:/tmp/pip-2ylUCi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:19:24 INFO - Running setup.py (path:/tmp/pip-JIFa6h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:19:24 INFO - Running setup.py (path:/tmp/pip-A2mnOQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:19:24 INFO - Running setup.py (path:/tmp/pip-ahMj77-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:19:24 INFO - Running setup.py (path:/tmp/pip-bjR9II-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:19:24 INFO - Running setup.py (path:/tmp/pip-kQLSwy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:19:24 INFO - Running setup.py (path:/tmp/pip-H5Ei9O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:19:24 INFO - Running setup.py (path:/tmp/pip-ClIU_x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:19:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:19:24 INFO - Running setup.py (path:/tmp/pip-AWjfYT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:19:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:19:25 INFO - Running setup.py (path:/tmp/pip-74Nyqo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:19:25 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:19:25 INFO - Running setup.py install for manifestparser 09:19:25 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Running setup.py install for mozcrash 09:19:25 INFO - Running setup.py install for mozdebug 09:19:25 INFO - Running setup.py install for mozdevice 09:19:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Running setup.py install for mozfile 09:19:25 INFO - Running setup.py install for mozhttpd 09:19:25 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Running setup.py install for mozinfo 09:19:25 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Running setup.py install for mozInstall 09:19:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:19:25 INFO - Running setup.py install for mozleak 09:19:25 INFO - Running setup.py install for mozlog 09:19:26 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Running setup.py install for moznetwork 09:19:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Running setup.py install for mozprocess 09:19:26 INFO - Running setup.py install for mozprofile 09:19:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Running setup.py install for mozrunner 09:19:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Running setup.py install for mozscreenshot 09:19:26 INFO - Running setup.py install for moztest 09:19:26 INFO - Running setup.py install for mozversion 09:19:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:19:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:19:26 INFO - Cleaning up... 09:19:26 INFO - Return code: 0 09:19:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:19:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 09:19:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:19:26 INFO - Using env: {'DISPLAY': ':0', 09:19:26 INFO - 'HOME': '/home/cltbld', 09:19:26 INFO - 'LANG': 'en_US.UTF-8', 09:19:26 INFO - 'LANGUAGE': 'en_US:en', 09:19:26 INFO - 'LOGNAME': 'cltbld', 09:19:26 INFO - 'MAIL': '/var/mail/cltbld', 09:19:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:26 INFO - 'MOZ_NO_REMOTE': '1', 09:19:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:26 INFO - 'NO_EM_RESTART': '1', 09:19:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:26 INFO - 'PWD': '/builds/slave/test', 09:19:26 INFO - 'SHELL': '/bin/bash', 09:19:26 INFO - 'SHLVL': '1', 09:19:26 INFO - 'TERM': 'linux', 09:19:26 INFO - 'TMOUT': '86400', 09:19:26 INFO - 'USER': 'cltbld', 09:19:26 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:26 INFO - '_': '/tools/buildbot/bin/python'} 09:19:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:19:27 INFO - Running setup.py (path:/tmp/pip-UsW0HA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:19:27 INFO - Running setup.py (path:/tmp/pip-8onRt7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:19:27 INFO - Running setup.py (path:/tmp/pip-JROLsa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:19:27 INFO - Running setup.py (path:/tmp/pip-NMOGWa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:19:27 INFO - Running setup.py (path:/tmp/pip-IbwYEx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:19:27 INFO - Running setup.py (path:/tmp/pip-mB1L0G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:19:27 INFO - Running setup.py (path:/tmp/pip-kJUdpk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:19:27 INFO - Running setup.py (path:/tmp/pip-ImZVaG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:19:27 INFO - Running setup.py (path:/tmp/pip-Lh1GlC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:19:27 INFO - Running setup.py (path:/tmp/pip-A605os-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:19:27 INFO - Running setup.py (path:/tmp/pip-V2TOhw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:19:27 INFO - Running setup.py (path:/tmp/pip-GLaRJP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:19:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 09:19:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:19:27 INFO - Running setup.py (path:/tmp/pip-RLhE4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 09:19:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:19:28 INFO - Running setup.py (path:/tmp/pip-bQ6JCF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 09:19:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:19:28 INFO - Running setup.py (path:/tmp/pip-ODaNgH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 09:19:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:19:28 INFO - Running setup.py (path:/tmp/pip-3iV10n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 09:19:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:19:28 INFO - Running setup.py (path:/tmp/pip-nPLoFj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:19:28 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 09:19:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:19:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:29 INFO - Downloading blessings-1.6.tar.gz 09:19:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:19:29 INFO - Installing collected packages: blessings 09:19:29 INFO - Running setup.py install for blessings 09:19:29 INFO - Successfully installed blessings 09:19:29 INFO - Cleaning up... 09:19:29 INFO - Return code: 0 09:19:29 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:19:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:19:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:19:29 INFO - Reading from file tmpfile_stdout 09:19:29 INFO - Current package versions: 09:19:29 INFO - argparse == 1.2.1 09:19:29 INFO - blessings == 1.6 09:19:29 INFO - blobuploader == 1.2.4 09:19:29 INFO - docopt == 0.6.1 09:19:29 INFO - functools32 == 3.2.3-2 09:19:29 INFO - jsonschema == 2.5.1 09:19:29 INFO - manifestparser == 1.1 09:19:29 INFO - mozInstall == 1.13 09:19:29 INFO - mozcrash == 1.0 09:19:29 INFO - mozdebug == 0.1 09:19:29 INFO - mozdevice == 0.51 09:19:29 INFO - mozfile == 1.2 09:19:29 INFO - mozhttpd == 0.7 09:19:29 INFO - mozinfo == 0.10 09:19:29 INFO - mozleak == 0.1 09:19:29 INFO - mozlog == 3.4 09:19:29 INFO - moznetwork == 0.27 09:19:29 INFO - mozprocess == 0.25 09:19:29 INFO - mozprofile == 0.28 09:19:29 INFO - mozrunner == 6.13 09:19:29 INFO - mozscreenshot == 0.1 09:19:29 INFO - mozsystemmonitor == 0.3 09:19:29 INFO - moztest == 0.8 09:19:29 INFO - mozversion == 1.4 09:19:29 INFO - psutil == 3.1.1 09:19:29 INFO - requests == 1.2.3 09:19:29 INFO - wsgiref == 0.1.2 09:19:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:19:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 09:19:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:19:29 INFO - Using env: {'DISPLAY': ':0', 09:19:29 INFO - 'HOME': '/home/cltbld', 09:19:29 INFO - 'LANG': 'en_US.UTF-8', 09:19:29 INFO - 'LANGUAGE': 'en_US:en', 09:19:29 INFO - 'LOGNAME': 'cltbld', 09:19:29 INFO - 'MAIL': '/var/mail/cltbld', 09:19:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:29 INFO - 'MOZ_NO_REMOTE': '1', 09:19:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:29 INFO - 'NO_EM_RESTART': '1', 09:19:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:29 INFO - 'PWD': '/builds/slave/test', 09:19:29 INFO - 'SHELL': '/bin/bash', 09:19:29 INFO - 'SHLVL': '1', 09:19:29 INFO - 'TERM': 'linux', 09:19:29 INFO - 'TMOUT': '86400', 09:19:29 INFO - 'USER': 'cltbld', 09:19:29 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:29 INFO - '_': '/tools/buildbot/bin/python'} 09:19:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 09:19:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 09:19:30 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:19:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:19:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:19:31 INFO - Downloading marionette_driver-1.4.0.tar.gz 09:19:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 09:19:31 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:19:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 09:19:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner>=6.9 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:19:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice>=0.37 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozrunner>=6.9->marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:19:31 INFO - Installing collected packages: marionette-driver 09:19:31 INFO - Running setup.py install for marionette-driver 09:19:31 INFO - Successfully installed marionette-driver 09:19:31 INFO - Cleaning up... 09:19:31 INFO - Return code: 0 09:19:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:19:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f943b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x216ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23129a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:19:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:19:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:19:31 INFO - Using env: {'DISPLAY': ':0', 09:19:31 INFO - 'HOME': '/home/cltbld', 09:19:31 INFO - 'LANG': 'en_US.UTF-8', 09:19:31 INFO - 'LANGUAGE': 'en_US:en', 09:19:31 INFO - 'LOGNAME': 'cltbld', 09:19:31 INFO - 'MAIL': '/var/mail/cltbld', 09:19:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:31 INFO - 'MOZ_NO_REMOTE': '1', 09:19:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:31 INFO - 'NO_EM_RESTART': '1', 09:19:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:31 INFO - 'PWD': '/builds/slave/test', 09:19:31 INFO - 'SHELL': '/bin/bash', 09:19:31 INFO - 'SHLVL': '1', 09:19:31 INFO - 'TERM': 'linux', 09:19:31 INFO - 'TMOUT': '86400', 09:19:31 INFO - 'USER': 'cltbld', 09:19:31 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:31 INFO - '_': '/tools/buildbot/bin/python'} 09:19:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:31 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:19:31 INFO - Cleaning up... 09:19:31 INFO - Return code: 0 09:19:31 INFO - Running post-action listener: _resource_record_post_action 09:19:31 INFO - Running post-action listener: _start_resource_monitoring 09:19:31 INFO - Starting resource monitoring. 09:19:31 INFO - [mozharness: 2017-06-16 16:19:31.642649Z] Finished create-virtualenv step (success) 09:19:31 INFO - [mozharness: 2017-06-16 16:19:31.643150Z] Running install step. 09:19:31 INFO - Running pre-action listener: _resource_record_pre_action 09:19:31 INFO - Running main action method: install 09:19:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:19:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:19:31 INFO - Reading from file tmpfile_stdout 09:19:31 INFO - Detecting whether we're running mozinstall >=1.0... 09:19:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:19:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:19:31 INFO - Reading from file tmpfile_stdout 09:19:31 INFO - Output received: 09:19:31 INFO - Usage: mozinstall [options] installer 09:19:31 INFO - Options: 09:19:31 INFO - -h, --help show this help message and exit 09:19:31 INFO - -d DEST, --destination=DEST 09:19:31 INFO - Directory to install application into. [default: 09:19:31 INFO - "/builds/slave/test"] 09:19:31 INFO - --app=APP Application being installed. [default: firefox] 09:19:31 INFO - mkdir: /builds/slave/test/build/application 09:19:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:19:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 09:19:49 INFO - Reading from file tmpfile_stdout 09:19:49 INFO - Output received: 09:19:49 INFO - /builds/slave/test/build/application/firefox/firefox 09:19:49 INFO - Running post-action listener: _resource_record_post_action 09:19:49 INFO - [mozharness: 2017-06-16 16:19:49.820317Z] Finished install step (success) 09:19:49 INFO - [mozharness: 2017-06-16 16:19:49.820460Z] Running setup-mitmproxy step. 09:19:49 INFO - Running pre-action listener: _resource_record_pre_action 09:19:49 INFO - Running main action method: setup_mitmproxy 09:19:49 INFO - Skipping: mitmproxy is not required 09:19:49 INFO - Running post-action listener: _resource_record_post_action 09:19:49 INFO - [mozharness: 2017-06-16 16:19:49.820990Z] Finished setup-mitmproxy step (success) 09:19:49 INFO - [mozharness: 2017-06-16 16:19:49.821119Z] Running run-tests step. 09:19:49 INFO - Running pre-action listener: _resource_record_pre_action 09:19:49 INFO - Running main action method: run_tests 09:19:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:19:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:19:49 INFO - Python 2.7.3 09:19:49 INFO - Return code: 0 09:19:49 INFO - grabbing minidump binary from tooltool 09:19:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:19:49 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2310a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2310ed0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:19:49 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 09:19:49 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 09:19:49 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 09:19:49 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:19:49 INFO - Return code: 0 09:19:49 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:19:49 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:19:49 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:19:49 INFO - ENV: RUST_BACKTRACE is now 1 09:19:49 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:19:49 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:19:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-079', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 09:19:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-079 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 09:19:49 INFO - Using env: {'DISPLAY': ':0', 09:19:49 INFO - 'HOME': '/home/cltbld', 09:19:49 INFO - 'LANG': 'en_US.UTF-8', 09:19:49 INFO - 'LANGUAGE': 'en_US:en', 09:19:49 INFO - 'LOGNAME': 'cltbld', 09:19:49 INFO - 'MAIL': '/var/mail/cltbld', 09:19:49 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:19:49 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:19:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:49 INFO - 'MOZ_NO_REMOTE': '1', 09:19:49 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:19:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:49 INFO - 'NO_EM_RESTART': '1', 09:19:49 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:19:49 INFO - 'PWD': '/builds/slave/test', 09:19:49 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:19:49 INFO - 'RUST_BACKTRACE': '1', 09:19:49 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 09:19:49 INFO - 'SHELL': '/bin/bash', 09:19:49 INFO - 'SHLVL': '1', 09:19:49 INFO - 'TERM': 'linux', 09:19:49 INFO - 'TMOUT': '86400', 09:19:49 INFO - 'USER': 'cltbld', 09:19:49 INFO - 'XDG_SESSION_COOKIE': '1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955', 09:19:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:49 INFO - '_': '/tools/buildbot/bin/python'} 09:19:49 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-079', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 09:19:50 INFO - mozversion application_buildid: 20170616153748 09:19:50 INFO - mozversion application_changeset: 58c5151bfd62de934b2286dbd664e69886270e28 09:19:50 INFO - mozversion application_display_name: Nightly 09:19:50 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:19:50 INFO - mozversion application_name: Firefox 09:19:50 INFO - mozversion application_remotingname: firefox 09:19:50 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 09:19:50 INFO - mozversion application_vendor: Mozilla 09:19:50 INFO - mozversion application_version: 56.0a1 09:19:50 INFO - mozversion platform_buildid: 20170616153748 09:19:50 INFO - mozversion platform_changeset: 58c5151bfd62de934b2286dbd664e69886270e28 09:19:50 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 09:19:50 INFO - mozversion platform_version: 56.0a1 09:19:50 INFO - using testdate: 1497629990 09:19:50 INFO - actual date: 1497629990 09:19:50 INFO - starting webserver on 'localhost:36186' 09:19:50 INFO - SUITE-START | Running 2 tests 09:19:50 INFO - TEST-START | dromaeo_css 09:19:50 INFO - operating with platform_type : linux_ 09:19:50 INFO - Initialising browser for dromaeo_css test... 09:19:50 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:36186/getInfo.html -profile /tmp/tmp40gcs7/profile 09:19:50 INFO - TEST-INFO | started process 28890 (/builds/slave/test/build/application/firefox/firefox http://localhost:36186/getInfo.html) 09:19:56 INFO - TEST-INFO | 28890: exit 0 09:19:57 INFO - Browser initialized. 09:19:57 INFO - Running cycle 1/1 for dromaeo_css test... 09:19:57 INFO - TEST-INFO | started process 29125 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp40gcs7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:20:08 INFO - PID 29125 | RSS: Main: 179326976 09:20:08 INFO - PID 29125 | 09:23:12 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36186/tests/dromaeo/cssquery-ext.html) 09:23:14 INFO - PID 29125 | RSS: Main: 185442304 09:23:14 INFO - PID 29125 | 09:26:16 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-ext.html (next: http://localhost:36186/tests/dromaeo/cssquery-jquery.html) 09:26:16 INFO - PID 29125 | RSS: Main: 183939072 09:26:16 INFO - PID 29125 | 09:29:18 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36186/tests/dromaeo/cssquery-mootools.html) 09:29:19 INFO - PID 29125 | RSS: Main: 186351616 09:29:19 INFO - PID 29125 | 09:32:20 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36186/tests/dromaeo/cssquery-prototype.html) 09:32:21 INFO - PID 29125 | RSS: Main: 182480896 09:32:21 INFO - PID 29125 | 09:35:24 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36186/tests/dromaeo/cssquery-yui.html) 09:35:24 INFO - PID 29125 | RSS: Main: 187453440 09:35:24 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | Cycle 1(1): loaded http://localhost:36186/tests/dromaeo/cssquery-yui.html (next: http://localhost:36186/tests/dromaeo/cssquery-dojo.html) 09:38:26 INFO - PID 29125 | RSS: Main: 184307712 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | __start_tp_report 09:38:26 INFO - PID 29125 | _x_x_mozilla_page_load 09:38:26 INFO - PID 29125 | _x_x_mozilla_page_load_details 09:38:26 INFO - PID 29125 | |i|pagename|runs| 09:38:26 INFO - PID 29125 | |0;dojo.html;3131.8434078296086;3144.8427578621063;3169.1918560767;3177.5392568077627;3188.4898416253404;5908.67502287374;6051.183090282811;6077.604955677878;6115.755369785204;6124.908126378108;5966.79116230932;5974.31295401029;6040.063790112528;6050.939490605093;6085.543584231178;5507.366652834935;5544.944550554484;5588.413216612258;5594.468525490092;5665.5467562594895;5597.020521408757;5641.887162256752;5660.575456840733;5663.405342439047;5690.658560486363;5576.609637325389;5627;5639.577031722617;5654.660720356792;5674.858128546799;5603.187537806995;5648.915266271029;5659.122835960433;5681;5705.6006079574445;5598.44015598441;5664.065429204176;5666.1784041314195;5690.943090569082;5693.202951586781;6026.849328766816;6078.665673387962;6139.754409823602;6200.565960382775;6201;5539.529140023063;6166.229221347332;6416.711247993805;6420.807375778734;6572.145621069279;6265.843353916143;6629.237637671681;6630.93369066308;6631.668416579152;6654.13496245485;6119.632822030692;6132.202813634199;6136.7852125175405;6150.231221097363;6151.600145990586;6726.529142960044;6737.59574425536;6778.7288508459105;6780.72877084911;6794.660266986631;6231.345708700612;6309.873802523924;6337.33457986914;6376.362363763679;6387.648679322589;6395.680215989182;6444.387783160592;6480.157579514633;6487.967560162169;6512.934870651327;6423.74305027803;6482.67586620667;6505.251896031922;6508.869822603521;6518.608883467007;6411.839704007344;6482.870342593122;6509.251436084816;6536.869262614816;6537.640429776408;5148.613853960968;5201.349831271091;5217.373915130132;5257.553107985864;5261.316028916216;4454.510003899569;4476.820927162877;4532.546745325441;4544.909101817945;4582.266837306015;5698.544116470673;5712.857178570486;5713.342965558931;5759.452851979056;5760.855978600484;6576.408123268929;6622.63575503352;6629.668516574152;6636.8672626547195;6656.4009239167735;5593.804216852472;5648.519875810603;5716.914246286309;5759.971200143972;5759.971200144057;5696;5733.483986441241;5741.5119714824705;5744.856378590569;5757.971210144006;6288.779892703825;6297.811065668037;6299.590526615755;6374.139491168633;6389.8722025560155;6370.108184854217;6534.8890688582105;6535.248446428722;6573.80278591643;6575.178102737158;6204.007358822567;6277.937220627735;6279.183706118358;6286.497080233479;6294.905576416449;6348.523860710373;6376.489880809617;6421.93578064232;6426.228852537725;6459.386358295955;6574.178227721535;6622.503312251697;6652.368025037614;6660.167479065117;6660.933390666031;6400.551961362846;6409.198850143732;6409.2949775525585;6412;6418.4865210783955;6119.326874043941;6401.615903045646;6403.423691867754;6440.774572889926;6445.355464453704;6095.969520152371;6154.569180157346;6184.033894414322;6201.596896201732;6203.875922481616;6250;6415.262244841716;6445.452136568444;6463.9980802975615;6466.288708242184;6255.812325630056;6266.968665156827;6270.184875966095;6276.686165691606;6278.4035516625845 09:38:26 INFO - PID 29125 | |1;ext.html;700.2612244082494;715.4634024481638;745.8321877577544;754.5284197376641;758.1016495452885;37314.25371492568;37917.241655166916;37919.431208531896;38034;38091.61908380912;34872.47691284633;35263;35278.823605882;35365;35385.64614353856;6391.808245752623;6467.8059658210095;6468.838279043014;6479.74081036758;6483.22201335838;6410.839729006789;6448.097266382711;6470.126532918066;6475.514336424763;6515.869682606345;6398.4561312288515;6403.647799371032;6431.067495213191;6480.4491618212505;6483;6462.321456247097;6485.870282594322;6491.93508064918;6505.967470162643;6507.967460162693;5855.092460668603;5881.617694849864;5891.086881533369;5903.232579764646;5909.645421274738;31327.37345253082;31583.84208078968;31630.36739265225;31634;31685.683143168502;3222.7582931280012;3230.6769323067506;3239.6922292382187;3345.3643807676463;3449.034270404291;28297.717022829715;28302.433951320858;28336.574951375747;28366.716332836615;28394;3613.3676606594004;3656.542932133483;3663.0292972362345;3672.137047793766;3718.0704823794053;163948;164824;175776;176262;176546;39492.407613885814;39763.60236397599;45817.77091114523;46336;46356;46679.29981050287;46983.06033879303;47113.52886471091;47153;47163.76418117888;15010.099394036393;15091.924540377448;15106.471273505595;15248.695026099416;15263.542093737206;12450.626481205578;12479.875201248053;12498.125131240726;12525.498980040878;12527.43626536808;13334.26661533625;13548.525801596898;13606.115602485806;13719.245441500614;13904.930475347559;5506.449355064542;5651.547876169897;5748.971255143698;5771.863041892719;5783.450572195635;975.4989805640691;981.9018098190123;982.7248370456284;1010.4745532323298;1024.5491983527224;21950.780492194874;22295.665565016538;22843.31470055901;23332;29723;1115.4924509348227;1116.625930313354;1123.4326665034105;1123.8258069999;1125.836753670713;12986;16103.516894493185;16347.178379024204;16358;16419.753703694456;210471;212012;212217;213729;213755;52939;53281.73359133257;53333.200002;53503.46496535063;53653.195202072;1435.8635929586674;1476.29138013754;1483.807105076333;1484.2727063738905;1485.7102864941448;26270;28506.42987140287;28561;28604.85697571499;28744;37179.8141009304;37294.44058339073;37337;37388.43917341297;37415;195951;196315;197242;197514;197631;31909.20226994344;33162.66837331596;33424.498632520044;33888.83055584706;33916.660833391354;41694.58305416907;42235;42262.366064509675;43125.353119703854;44033.339499906884;31122.688773112885;31665.84167079242;32456.675433245364;32581.34837303288;32703.307026513685;31019.224519387197;31408.528872067393;31631;32021;32139;36019.27961440704;36349.81825090964;36489.63510364862;36540.45189322109;36545.817270913474;28348.71651283543;30043.699563004964;31102.533461997635;31387.84306078455;31759;22280;24443.633345499475;24542.754572454047;24545.386365341008;24933.252002439956 09:38:26 INFO - PID 29125 | |2;jquery.html;491.6288202407182;499.7132384110913;511.2152845382338;518.9299444574981;524.4571868116499;19018.429447116574;19604.803951960475;19783.703244451346;20429.182832686693;20439.795602043974;21508.56982860342;21897;22228.333150005485;22304;22314.55370892581;4695.272232803921;4730.621550275987;4922.70463772173;4945.876353091166;4998.700077995314;5950.166976623276;6040.275166979968;6045.214122164112;6071.544634152434;6080.908786368186;5628.859278518049;5801.158831969362;5857;5883.058710606304;6042.818715438544;5706.77172913083;5751.166080918264;5767.855803604923;5784.219130417382;5792.189093526909;5365.543928766059;5376.51611354976;5376.569874410038;5380.112281473552;5398.433164517708;24733.25800225996;25190.874045629836;25200.243992680247;25212;25268.747312527008;1859.0890463672704;1893.195391958412;1938.5832046110013;1943.834774044208;1955.4231501706888;16748.83251167485;17093.65812683752;17125.65748685032;17137;17154;2141.775113613079;2165.101482884601;2195.10000899632;2195.242641288753;2304.700388949426;96109;98116.50941745246;98165.50917245439;111267.44366278198;117315;19384.576927884016;19386.224551018084;19682.90158549227;20323.491912702302;20603.067818889835;39561.604383956364;39783.40324895129;39785.20429591392;39834.60165398367;39963.80018099949;10010;10224.28430009907;10351;10406.895931040593;10466.372017678963;8505.10696376884;8569.614367353484;8594.441361311494;8631.741047768577;8636.093210212963;10808.729781755519;10855.185861060294;10884.238103332691;10928.032954068185;11046.668599942015;3785.167263202091;4121.186677861731;4178.91642167155;4259.446271984684;4325.6106950374615;945.5981207986579;950.8811398575178;957.3011701457835;982.6175258347706;987.6000219910948;18535.907320463582;18766.155523001224;21262.149514019267;21440.24959126423;22264.666030009565;991.7867658453323;1000.1848493477793;1008.6016023670609;1019.3021012539938;1024.2420608749471;10365.429901355346;10402.167826573856;10542.47287635615;10653.520591573242;10948.671539853816;443980;456989;458162;460995;467911;100651;100791;102007;102814;105026.47486762518;1199.0647295109654;1214.9210301330386;1238.1642391385778;1248.095131029996;1249.6188662458037;15723.371065157266;15745.606359841096;16602.66794664076;16930.66138677244;17189.742153867952;44740.32889506725;46756;47077.293840593105;48144.51855481401;48612.2708159385;59059;59363.1095533576;59534.40465595289;59722.402775971685;60004;11063.557457701601;11233.269837460866;11276.830847537458;11362.318260904372;11429.485673144894;13996.37016334247;15581.688366232838;15732.05607663544;15805.051696898223;15944.920275398548;14265.857341426452;14669.48656797007;14677.77639597065;14743.041702289745;14856.925715371353;10177.643782467578;12709.36453177319;12758.68103297425;13680.179189248676;14137.858621413654;14414.063085899383;14565.563033109023;14570.781438278646;14609.780853287422;14644.26778661084;11275.605353812578;11565.306081635128;11833.11251656112;11835.644930652094;11850.703732406413;14196.077254978394;14276.357563909442;14324.355404006636;14363.066400683922;14417.92791036038 09:38:26 INFO - PID 29125 | |3;mootools.html;1314.1786383510305;1374.099964523237;1380.02708090796;1393.9651508712286;1402.7404930087932;12590.811137832929;13157.868421315785;13165.736685266289;13188.472461101557;13209.603711888634;12764.361781910891;13143.211407315568;13145.211287322743;13148.802767958465;13215.867841321584;2437.6465412515176;2487.017628036924;2496.8002559795264;2499.0503608628696;2509.6862892138483;2431.8662473563945;2487.5522405966917;2529.633203185537;2535.949281014379;2548.7706106450414;2415.1426243683504;2466.1984854922134;2475.9752402475924;2480.6155045967903;2493.6633554470186;2387.964180537302;2405.410674384769;2409.084547871815;2414.1912459326145;2422.2975337152207;2315.166540045582;2357.599208134621;2365.940851478727;2368.7275963264274;2384.6303822907475;12657.43041563132;12672.556460523929;12826.35868206586;12828.166169199065;12839.358032098358;6767.695453704595;7010.123734533184;7014;7014.719411223545;7016.964915175443;4209.0950445654025;4258.68059895509;4301.978490107529;4356.281213599752;4434.49003364614;1355.627202519315;1360.347033423962;1391.6033930329806;1415.723933832903;1417.029334905593;18487.445376638723;19212.615747685108;19842.503937401536;19906.701399479018;19989.80010199894;5158.767855446514;5872.060470324727;5980.162777211194;6006.519478441714;6075.179850720185;14374;14405.495807646683;14411.495597654031;14430.062045966979;14437.85562144365;7009.894851577231;7073.82315442118;7108.751193708195;7113.359797618239;7115.75094871677;6288.465480434214;6590.143281373391;6633.005049242653;6648.83377915556;6665.166854143232;5041.621878359065;5133.743312834344;5144.8713782155;5151.501521761942;5158.587313014949;1589.348367169455;1591.8726501879821;1602.5512856400226;1623.6346821965199;1634.7629593708846;867.947923124602;868.2402897464718;882.9337799665051;894.7763059235191;924.5977999570208;6711.530192886548;6834.8633027340165;6906.133954408964;6941.097657304518;6980.336867997532;652.1749986267375;656.4977791989132;676.8138761840534;687.5153017123016;693.8681650486392;4225.450691410097;4416.780779285447;4931.432885218174;5184.48155184486;5340.8664783379945;17290.308387664605;17399.478015659297;17722.822771772375;17779.111044447727;17789.110544472725;15276.770848437282;16916.577085572713;17234.396796112327;17359;17496.650066998587;9673.951630241803;9787.608495660093;9847.064528869745;9917.603295868228;10210.38737675727;7337.3029562191505;7614.314711675976;7804.102528209329;7978.561179134971;8250.051244107004;14738.852611473749;15096.924515377354;15357.769633455284;15723.05661660304;15853.128077955824;14396.568102956928;14904.478343257933;15400;15777.405899543106;16087.195640218177;12086.758264834478;12422.192557483735;12493.375331233221;12556.37218139071;12581.622551323475;12285.815712764494;12414.255144691348;12430.502779889064;12452.252864828139;12506.624801255977;10123.746906327106;10142.645007424704;10154.492275386054;10307.639232626821;10340.844887326546;9906.306558540833;9925.602975880884;9939.701808945743;10049.69850904474;10157.085862272432;8625.180607842496;8884.244839188741;8991;9037.457752534869;9058.320625953213;6664.83337916556;6700.195976482853;6940.479464040116;7030.121234845645;7102.893456598052;6657.700403481952;6663.600183988976;6715.899261511179;6817.659117044029;6884.48366372514 09:38:26 INFO - PID 29125 | |4;prototype.html;439.9560043995599;457.75052596334996;470.42842945820826;471.75704512176213;477.2125992113013;6048.2137322148055;6264.62412255265;6322.272938612061;6345.58753681011;6368.936310636892;6000.439885629746;6078.5441091918065;6091.421314975081;6113.296970848353;6229.345918678541;5080.237964305346;5110.744462776865;5118.232265160219;5129.871753206163;5131.640785145041;5087.931534377785;5151.665141765792;5159.2003239497935;5199.610029247802;5199.792008319662;5045.445001049881;5073.416557095944;5076;5085.211792172201;5094.694318340893;4721.622270218374;4884.609231261491;4923.236898280737;5083.669561478492;5093.312402825627;4312.82748690052;4349.151915376503;4374.759388233646;4378.277584198603;4386.956130438687;6008.819735407945;6036.245469316335;6038.57729958903;6045.516358691294;6075.17985072014;5600.215969764236;5603.60774745768;5612.466815652507;5617.775288988436;5638.71806409682;6525.543211975164;6571.769988050443;6573.1783527059115;6588.110605068302;6588.571742836748;4753.9762301188275;4764.737939413331;4783.521647835223;4807.42310922688;4821.37322148122;6865.27914568968;6930.3367191874095;6939.962232857446;6942.687579058904;6953.478489113337;4881.219004959189;4911.901761964812;4939.3084968104495;4943.777530011086;4952.133376659071;4936.48166942473;5004.724740139327;5009.899802004013;5013.573846223039;5017.974910125426;5629.296337957755;5643.843012182493;5646.153077038395;5649;5674.97162514193;6635.270120286765;6658.3674550917585;6664.400203981665;6679.532432729759;6684;1617.1186703246758;1732.5755189978536;1740.2169023939277;1747.8514326282154;1753.509017475109;1185.887340702632;1193.2482536002262;1194.6918124653491;1202.6933132051272;1204.4278967490372;5528.834134975958;5689.9146512802345;5695.601307908407;5726;5743.655380677173;6657.567258128206;6694.330566943267;6760.966195168992;6775.932240677629;6826.795196144124;5825.300963884361;5831.883362332815;5835.387284335168;5853.239078919713;5860.677662728591;3576.964230357663;3578.570571531433;3594.6405359463843;3596.9100772480897;3604.846449136304;6260.937390626035;6547.526806468506;6580.012998050331;6593.604383736991;6605.6641396094665;6955.478938689892;6987.580745155307;6992.2658120897595;7009.299070093052;7019.859602808017;6539.803805885831;6542.705578248991;6582.045603387482;6583.407493325623;6595;6647.833804154935;6721;6721.462283017249;6746.4265537429865;6749.392554670103;6701.698423570853;6705.1283333166375;6705.8994115087335;6721.529492935448;6731.394174524316;6511.218653761579;6555.901661475177;6557.147570815763;6582.637954912526;6602.471802255904;4827.203511420576;4891.80432782699;4896.387951506062;4901.926471103007;4917.975410122926;6773.06967514256;6774.085498457645;6791.320867913169;6822.556533825285;6826.249112597709;6539.901901471577;6589.6375699336995;6621.404073633396;6622.8344291393105;6635.966820165868;6581.07864898905;6587.341265873374;6599.769008084694;6608.306127856506;6621.702023409054;6148.538859585459;6470.7088181032905;6477.481801455778;6531.3468653134305;6592.80221593353;6439.846299136937;6616.636085015371;6617.371349721769;6646.169228846395;6658;6424.229092508929;6432.517561182836;6445.484361251182;6455.806325810233;6476.967615161894 09:38:26 INFO - PID 29125 | |5;yui.html;821.5235163605109;830.2776584371597;841.3731769831477;841.8274253777976;845.4251109245711;16801.831981680196;17461.301547938067;17477.825221747793;17485.47543573695;17514.91242543787;18306.542336441595;19614.215431382763;19678.212871485124;19749.60500789987;19765.60468790627;993.9552720127575;1000.5047501486774;1003.6336737090945;1006.0342071611262;1010.7220514358573;1018.4856647393057;1026.2251999740186;1027.337367398028;1027.3579013116803;1028.8816786069585;726.4878260826131;1044.4046893270838;1048.355261514171;1051.81593221186;1055.672741450149;740.2671355358184;878.7056336127373;1048.1143433798466;1052.6789329254575;1061.373789464212;771.6836097200177;776.0415886380316;776.7553220735507;778.2878666020584;778.4161878591057;17953.192106355116;18414;18628.813711862844;18644.906775466035;18680.439586812416;18579.907100464545;18870.81129188718;19085.427437176906;19126;19138.23447062116;14043.929780351134;14143.434262629482;14147.858521414757;14231.644208894757;14273.286335683279;3392.9830350848333;3484.163800687842;3485.581730192393;3520.612732599412;3526.1713497328105;89811;92140.53929730375;92788.53605731996;95982;100909.495452523;13763.655908602364;14027.649308767363;14091.647708807363;14107.224102674247;14180.574582762534;25343.74656253414;26272.605910911352;26301;26700.198994029823;26930;7607.961960190164;7619.619019049025;7635.770926872203;7685.03937007874;7686.192949740197;3954.723169378116;3967.7420967637013;4084.8774536763945;4106.301928672133;4145.398917156996;4609.7695115244105;4675.158471475099;4687.906241875212;4702.835400760957;4716.716996980193;833.7665453672981;858.592168719853;868.3227082875368;871.1897934920585;875.5709702245854;664.5381459885333;667.6594936582378;682.5529278322707;695.7425752471618;713.3152173913102;10932.104148498816;12325.260484370967;12422.503099875903;12424.254544727346;12730.872691273154;684.3874732114829;690.602903330587;696.8397268628142;702.9718811247493;722.8734971380093;5128.538431541179;5156.278121063054;5181.53366197044;5315.495027972336;5334.17320315344;88595;91815.54092229497;91900.54049729709;92240;95065;72235;73837.63081184559;73974.63012684902;75187.24812751802;75297;69828;70466.64766676236;72082;73139.63430182921;74437.62781186168;11211.159163062966;11804.350760708243;11813.881861181279;12138.33239171854;12418.254904705747;29665;31097.533536997416;31792;32033.839830800698;32816.34367312688;37427;38809.6119038806;40052.399214012396;40446.1910761789;40797.1840563193;17508.562285942444;17700;17720;18143;18166.455006349832;18494.630107398047;18982.525436864187;19370.903145484182;19489.902550487157;19526.21895124179;17114.82885171182;17446.47660570185;17530.89998550589;18189.18148683339;18239.361622343153;16268.267927943034;17339.2197351117;17676.116194190497;17800.821991779918;17897.910510447884;17582.472525824247;17583.560410989827;17737.467875963743;17742.11289435549;17943.371981980566;11365.00750387656;12206.755864882474;12397.876021240032;12526.498940042296;12618.305993170097;13097.803532946822;13193;13214.141080829715;13717.931410342884;13792.448302067805 09:38:26 INFO - PID 29125 | __end_tp_report 09:38:26 INFO - PID 29125 | __start_cc_report 09:38:26 INFO - PID 29125 | _x_x_mozilla_cycle_collect,380 09:38:26 INFO - PID 29125 | __end_cc_report 09:38:26 INFO - PID 29125 | __startTimestamp1497631106787__endTimestamp 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | ------- Summary: start ------- 09:38:26 INFO - PID 29125 | Number of tests: 6 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#0] dojo.html Cycles:165 Average:6009.58 Median:6203.88 stddev:693.04 (11.2%) stddev-sans-first:657.37 09:38:26 INFO - PID 29125 | Values: 3131.8 3144.8 3169.2 3177.5 3188.5 5908.7 6051.2 6077.6 6115.8 6124.9 5966.8 5974.3 6040.1 6050.9 6085.5 5507.4 5544.9 5588.4 5594.5 5665.5 5597.0 5641.9 5660.6 5663.4 5690.7 5576.6 5627.0 5639.6 5654.7 5674.9 5603.2 5648.9 5659.1 5681.0 5705.6 5598.4 5664.1 5666.2 5690.9 5693.2 6026.8 6078.7 6139.8 6200.6 6201.0 5539.5 6166.2 6416.7 6420.8 6572.1 6265.8 6629.2 6630.9 6631.7 6654.1 6119.6 6132.2 6136.8 6150.2 6151.6 6726.5 6737.6 6778.7 6780.7 6794.7 6231.3 6309.9 6337.3 6376.4 6387.6 6395.7 6444.4 6480.2 6488.0 6512.9 6423.7 6482.7 6505.3 6508.9 6518.6 6411.8 6482.9 6509.3 6536.9 6537.6 5148.6 5201.3 5217.4 5257.6 5261.3 4454.5 4476.8 4532.5 4544.9 4582.3 5698.5 5712.9 5713.3 5759.5 5760.9 6576.4 6622.6 6629.7 6636.9 6656.4 5593.8 5648.5 5716.9 5760.0 5760.0 5696.0 5733.5 5741.5 5744.9 5758.0 6288.8 6297.8 6299.6 6374.1 6389.9 6370.1 6534.9 6535.2 6573.8 6575.2 6204.0 6277.9 6279.2 6286.5 6294.9 6348.5 6376.5 6421.9 6426.2 6459.4 6574.2 6622.5 6652.4 6660.2 6660.9 6400.6 6409.2 6409.3 6412.0 6418.5 6119.3 6401.6 6403.4 6440.8 6445.4 6096.0 6154.6 6184.0 6201.6 6203.9 6250.0 6415.3 6445.5 6464.0 6466.3 6255.8 6267.0 6270.2 6276.7 6278.4 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#1] ext.html Cycles:180 Average:35655.93 Median:32932.99 stddev:50326.70 (152.8%) stddev-sans-first:50399.43 09:38:26 INFO - PID 29125 | Values: 700.3 715.5 745.8 754.5 758.1 37314.3 37917.2 37919.4 38034.0 38091.6 34872.5 35263.0 35278.8 35365.0 35385.6 6391.8 6467.8 6468.8 6479.7 6483.2 6410.8 6448.1 6470.1 6475.5 6515.9 6398.5 6403.6 6431.1 6480.4 6483.0 6462.3 6485.9 6491.9 6506.0 6508.0 5855.1 5881.6 5891.1 5903.2 5909.6 31327.4 31583.8 31630.4 31634.0 31685.7 3222.8 3230.7 3239.7 3345.4 3449.0 28297.7 28302.4 28336.6 28366.7 28394.0 3613.4 3656.5 3663.0 3672.1 3718.1 163948.0 164824.0 175776.0 176262.0 176546.0 39492.4 39763.6 45817.8 46336.0 46356.0 46679.3 46983.1 47113.5 47153.0 47163.8 15010.1 15091.9 15106.5 15248.7 15263.5 12450.6 12479.9 12498.1 12525.5 12527.4 13334.3 13548.5 13606.1 13719.2 13904.9 5506.4 5651.5 5749.0 5771.9 5783.5 975.5 981.9 982.7 1010.5 1024.5 21950.8 22295.7 22843.3 23332.0 29723.0 1115.5 1116.6 1123.4 1123.8 1125.8 12986.0 16103.5 16347.2 16358.0 16419.8 210471.0 212012.0 212217.0 213729.0 213755.0 52939.0 53281.7 53333.2 53503.5 53653.2 1435.9 1476.3 1483.8 1484.3 1485.7 26270.0 28506.4 28561.0 28604.9 28744.0 37179.8 37294.4 37337.0 37388.4 37415.0 195951.0 196315.0 197242.0 197514.0 197631.0 31909.2 33162.7 33424.5 33888.8 33916.7 41694.6 42235.0 42262.4 43125.4 44033.3 31122.7 31665.8 32456.7 32581.3 32703.3 31019.2 31408.5 31631.0 32021.0 32139.0 36019.3 36349.8 36489.6 36540.5 36545.8 28348.7 30043.7 31102.5 31387.8 31759.0 22280.0 24443.6 24542.8 24545.4 24933.3 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#2] jquery.html Cycles:180 Average:31279.84 Median:20434.49 stddev:76178.99 (372.8%) stddev-sans-first:76357.62 09:38:26 INFO - PID 29125 | Values: 491.6 499.7 511.2 518.9 524.5 19018.4 19604.8 19783.7 20429.2 20439.8 21508.6 21897.0 22228.3 22304.0 22314.6 4695.3 4730.6 4922.7 4945.9 4998.7 5950.2 6040.3 6045.2 6071.5 6080.9 5628.9 5801.2 5857.0 5883.1 6042.8 5706.8 5751.2 5767.9 5784.2 5792.2 5365.5 5376.5 5376.6 5380.1 5398.4 24733.3 25190.9 25200.2 25212.0 25268.7 1859.1 1893.2 1938.6 1943.8 1955.4 16748.8 17093.7 17125.7 17137.0 17154.0 2141.8 2165.1 2195.1 2195.2 2304.7 96109.0 98116.5 98165.5 111267.4 117315.0 19384.6 19386.2 19682.9 20323.5 20603.1 39561.6 39783.4 39785.2 39834.6 39963.8 10010.0 10224.3 10351.0 10406.9 10466.4 8505.1 8569.6 8594.4 8631.7 8636.1 10808.7 10855.2 10884.2 10928.0 11046.7 3785.2 4121.2 4178.9 4259.4 4325.6 945.6 950.9 957.3 982.6 987.6 18535.9 18766.2 21262.1 21440.2 22264.7 991.8 1000.2 1008.6 1019.3 1024.2 10365.4 10402.2 10542.5 10653.5 10948.7 443980.0 456989.0 458162.0 460995.0 467911.0 100651.0 100791.0 102007.0 102814.0 105026.5 1199.1 1214.9 1238.2 1248.1 1249.6 15723.4 15745.6 16602.7 16930.7 17189.7 44740.3 46756.0 47077.3 48144.5 48612.3 59059.0 59363.1 59534.4 59722.4 60004.0 11063.6 11233.3 11276.8 11362.3 11429.5 13996.4 15581.7 15732.1 15805.1 15944.9 14265.9 14669.5 14677.8 14743.0 14856.9 10177.6 12709.4 12758.7 13680.2 14137.9 14414.1 14565.6 14570.8 14609.8 14644.3 11275.6 11565.3 11833.1 11835.6 11850.7 14196.1 14276.4 14324.4 14363.1 14417.9 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#3] mootools.html Cycles:180 Average:8026.28 Median:2451.92 stddev:5316.40 (216.8%) stddev-sans-first:5307.39 09:38:26 INFO - PID 29125 | Values: 1314.2 1374.1 1380.0 1394.0 1402.7 12590.8 13157.9 13165.7 13188.5 13209.6 12764.4 13143.2 13145.2 13148.8 13215.9 2437.6 2487.0 2496.8 2499.1 2509.7 2431.9 2487.6 2529.6 2535.9 2548.8 2415.1 2466.2 2476.0 2480.6 2493.7 2388.0 2405.4 2409.1 2414.2 2422.3 2315.2 2357.6 2365.9 2368.7 2384.6 12657.4 12672.6 12826.4 12828.2 12839.4 6767.7 7010.1 7014.0 7014.7 7017.0 4209.1 4258.7 4302.0 4356.3 4434.5 1355.6 1360.3 1391.6 1415.7 1417.0 18487.4 19212.6 19842.5 19906.7 19989.8 5158.8 5872.1 5980.2 6006.5 6075.2 14374.0 14405.5 14411.5 14430.1 14437.9 7009.9 7073.8 7108.8 7113.4 7115.8 6288.5 6590.1 6633.0 6648.8 6665.2 5041.6 5133.7 5144.9 5151.5 5158.6 1589.3 1591.9 1602.6 1623.6 1634.8 867.9 868.2 882.9 894.8 924.6 6711.5 6834.9 6906.1 6941.1 6980.3 652.2 656.5 676.8 687.5 693.9 4225.5 4416.8 4931.4 5184.5 5340.9 17290.3 17399.5 17722.8 17779.1 17789.1 15276.8 16916.6 17234.4 17359.0 17496.7 9674.0 9787.6 9847.1 9917.6 10210.4 7337.3 7614.3 7804.1 7978.6 8250.1 14738.9 15096.9 15357.8 15723.1 15853.1 14396.6 14904.5 15400.0 15777.4 16087.2 12086.8 12422.2 12493.4 12556.4 12581.6 12285.8 12414.3 12430.5 12452.3 12506.6 10123.7 10142.6 10154.5 10307.6 10340.8 9906.3 9925.6 9939.7 10049.7 10157.1 8625.2 8884.2 8991.0 9037.5 9058.3 6664.8 6700.2 6940.5 7030.1 7102.9 6657.7 6663.6 6715.9 6817.7 6884.5 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#4] prototype.html Cycles:180 Average:5524.14 Median:6061.70 stddev:1572.70 (25.9%) stddev-sans-first:1530.11 09:38:26 INFO - PID 29125 | Values: 440.0 457.8 470.4 471.8 477.2 6048.2 6264.6 6322.3 6345.6 6368.9 6000.4 6078.5 6091.4 6113.3 6229.3 5080.2 5110.7 5118.2 5129.9 5131.6 5087.9 5151.7 5159.2 5199.6 5199.8 5045.4 5073.4 5076.0 5085.2 5094.7 4721.6 4884.6 4923.2 5083.7 5093.3 4312.8 4349.2 4374.8 4378.3 4387.0 6008.8 6036.2 6038.6 6045.5 6075.2 5600.2 5603.6 5612.5 5617.8 5638.7 6525.5 6571.8 6573.2 6588.1 6588.6 4754.0 4764.7 4783.5 4807.4 4821.4 6865.3 6930.3 6940.0 6942.7 6953.5 4881.2 4911.9 4939.3 4943.8 4952.1 4936.5 5004.7 5009.9 5013.6 5018.0 5629.3 5643.8 5646.2 5649.0 5675.0 6635.3 6658.4 6664.4 6679.5 6684.0 1617.1 1732.6 1740.2 1747.9 1753.5 1185.9 1193.2 1194.7 1202.7 1204.4 5528.8 5689.9 5695.6 5726.0 5743.7 6657.6 6694.3 6761.0 6775.9 6826.8 5825.3 5831.9 5835.4 5853.2 5860.7 3577.0 3578.6 3594.6 3596.9 3604.8 6260.9 6547.5 6580.0 6593.6 6605.7 6955.5 6987.6 6992.3 7009.3 7019.9 6539.8 6542.7 6582.0 6583.4 6595.0 6647.8 6721.0 6721.5 6746.4 6749.4 6701.7 6705.1 6705.9 6721.5 6731.4 6511.2 6555.9 6557.1 6582.6 6602.5 4827.2 4891.8 4896.4 4901.9 4918.0 6773.1 6774.1 6791.3 6822.6 6826.2 6539.9 6589.6 6621.4 6622.8 6636.0 6581.1 6587.3 6599.8 6608.3 6621.7 6148.5 6470.7 6477.5 6531.3 6592.8 6439.8 6616.6 6617.4 6646.2 6658.0 6424.2 6432.5 6445.5 6455.8 6477.0 09:38:26 INFO - PID 29125 | 09:38:26 INFO - PID 29125 | [#5] yui.html Cycles:180 Average:19568.36 Median:19757.60 stddev:24598.76 (124.5%) stddev-sans-first:24627.48 09:38:26 INFO - PID 29125 | Values: 821.5 830.3 841.4 841.8 845.4 16801.8 17461.3 17477.8 17485.5 17514.9 18306.5 19614.2 19678.2 19749.6 19765.6 994.0 1000.5 1003.6 1006.0 1010.7 1018.5 1026.2 1027.3 1027.4 1028.9 726.5 1044.4 1048.4 1051.8 1055.7 740.3 878.7 1048.1 1052.7 1061.4 771.7 776.0 776.8 778.3 778.4 17953.2 18414.0 18628.8 18644.9 18680.4 18579.9 18870.8 19085.4 19126.0 19138.2 14043.9 14143.4 14147.9 14231.6 14273.3 3393.0 3484.2 3485.6 3520.6 3526.2 89811.0 92140.5 92788.5 95982.0 100909.5 13763.7 14027.6 14091.6 14107.2 14180.6 25343.7 26272.6 26301.0 26700.2 26930.0 7608.0 7619.6 7635.8 7685.0 7686.2 3954.7 3967.7 4084.9 4106.3 4145.4 4609.8 4675.2 4687.9 4702.8 4716.7 833.8 858.6 868.3 871.2 875.6 664.5 667.7 682.6 695.7 713.3 10932.1 12325.3 12422.5 12424.3 12730.9 684.4 690.6 696.8 703.0 722.9 5128.5 5156.3 5181.5 5315.5 5334.2 88595.0 91815.5 91900.5 92240.0 95065.0 72235.0 73837.6 73974.6 75187.2 75297.0 69828.0 70466.6 72082.0 73139.6 74437.6 11211.2 11804.4 11813.9 12138.3 12418.3 29665.0 31097.5 31792.0 32033.8 32816.3 37427.0 38809.6 40052.4 40446.2 40797.2 17508.6 17700.0 17720.0 18143.0 18166.5 18494.6 18982.5 19370.9 19489.9 19526.2 17114.8 17446.5 17530.9 18189.2 18239.4 16268.3 17339.2 17676.1 17800.8 17897.9 17582.5 17583.6 17737.5 17742.1 17943.4 11365.0 12206.8 12397.9 12526.5 12618.3 13097.8 13193.0 13214.1 13717.9 13792.4 09:38:26 INFO - PID 29125 | -------- Summary: end -------- 09:38:26 INFO - PID 29125 | 09:38:27 INFO - TEST-INFO | 29125: exit 0 09:38:27 INFO - TEST-OK | dromaeo_css | took 1117273ms 09:38:27 INFO - TEST-START | kraken 09:38:27 INFO - operating with platform_type : linux_ 09:38:27 INFO - Initialising browser for kraken test... 09:38:27 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:36186/getInfo.html -profile /tmp/tmpt4c71t/profile 09:38:27 INFO - TEST-INFO | started process 29536 (/builds/slave/test/build/application/firefox/firefox http://localhost:36186/getInfo.html) 09:38:33 INFO - TEST-INFO | 29536: exit 0 09:38:33 INFO - Browser initialized. 09:38:33 INFO - Running cycle 1/1 for kraken test... 09:38:33 INFO - TEST-INFO | started process 29770 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpt4c71t/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:38:45 INFO - PID 29770 | RSS: Main: 179367936 09:38:45 INFO - PID 29770 | 09:38:47 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36186/tests/kraken/driver.html?testName=audio-beat-detection) 09:38:48 INFO - PID 29770 | RSS: Main: 183169024 09:38:48 INFO - PID 29770 | 09:38:51 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36186/tests/kraken/driver.html?testName=audio-dft) 09:38:52 INFO - PID 29770 | RSS: Main: 183635968 09:38:52 INFO - PID 29770 | 09:38:55 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36186/tests/kraken/driver.html?testName=audio-fft) 09:38:55 INFO - PID 29770 | RSS: Main: 180514816 09:38:55 INFO - PID 29770 | 09:38:57 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36186/tests/kraken/driver.html?testName=audio-oscillator) 09:38:58 INFO - PID 29770 | RSS: Main: 181035008 09:38:58 INFO - PID 29770 | 09:39:00 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36186/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:39:01 INFO - PID 29770 | RSS: Main: 180973568 09:39:01 INFO - PID 29770 | 09:39:04 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36186/tests/kraken/driver.html?testName=imaging-darkroom) 09:39:04 INFO - PID 29770 | RSS: Main: 184422400 09:39:04 INFO - PID 29770 | 09:39:08 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36186/tests/kraken/driver.html?testName=imaging-desaturate) 09:39:09 INFO - PID 29770 | RSS: Main: 186834944 09:39:09 INFO - PID 29770 | 09:39:11 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36186/tests/kraken/driver.html?testName=json-parse-financial) 09:39:12 INFO - PID 29770 | RSS: Main: 185475072 09:39:12 INFO - PID 29770 | 09:39:14 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36186/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:39:14 INFO - PID 29770 | RSS: Main: 186093568 09:39:14 INFO - PID 29770 | 09:39:16 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:39:17 INFO - PID 29770 | RSS: Main: 185868288 09:39:17 INFO - PID 29770 | 09:39:19 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:39:19 INFO - PID 29770 | RSS: Main: 184934400 09:39:19 INFO - PID 29770 | 09:39:22 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:39:23 INFO - PID 29770 | RSS: Main: 185016320 09:39:23 INFO - PID 29770 | 09:39:26 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:39:27 INFO - PID 29770 | RSS: Main: 185118720 09:39:27 INFO - PID 29770 | 09:39:28 INFO - PID 29770 | Cycle 1(1): loaded http://localhost:36186/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36186/tests/kraken/driver.html?testName=ai-astar) 09:39:29 INFO - PID 29770 | RSS: Main: 186245120 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | __start_tp_report 09:39:29 INFO - PID 29770 | _x_x_mozilla_page_load 09:39:29 INFO - PID 29770 | _x_x_mozilla_page_load_details 09:39:29 INFO - PID 29770 | |i|pagename|runs| 09:39:29 INFO - PID 29770 | |0;ai-astar;102;109;110;109;116;109;109;110;110;117 09:39:29 INFO - PID 29770 | |1;audio-beat-detection;151;127;146;176;124;146;153;123;169;125 09:39:29 INFO - PID 29770 | |2;audio-dft;166;164;164;162;164;175;172;195;163;162 09:39:29 INFO - PID 29770 | |3;audio-fft;74;77;76;155;73;73;74;84;97;74 09:39:29 INFO - PID 29770 | |4;audio-oscillator;83;82;136;82;82;83;132;83;82;145 09:39:29 INFO - PID 29770 | |5;imaging-gaussian-blur;114;114;115;114;114;113;113;113;114;114 09:39:29 INFO - PID 29770 | |6;imaging-darkroom;151;150;149;150;154;151;151;150;150;150 09:39:29 INFO - PID 29770 | |7;imaging-desaturate;100;93;99;95;95;94;95;98;94;94 09:39:29 INFO - PID 29770 | |8;json-parse-financial;55;56;53;53;56;55;57;56;55;52 09:39:29 INFO - PID 29770 | |9;json-stringify-tinderbox;57;55;55;55;55;54;55;56;56;56 09:39:29 INFO - PID 29770 | |10;stanford-crypto-aes;78;77;78;78;78;82;79;85;78;84 09:39:29 INFO - PID 29770 | |11;stanford-crypto-ccm;128;128;131;130;131;140;135;126;133;149 09:39:29 INFO - PID 29770 | |12;stanford-crypto-pbkdf2;199;190;193;189;193;188;201;187;187;187 09:39:29 INFO - PID 29770 | |13;stanford-crypto-sha256-iterative;70;72;75;77;70;71;72;71;72;73 09:39:29 INFO - PID 29770 | __end_tp_report 09:39:29 INFO - PID 29770 | __start_cc_report 09:39:29 INFO - PID 29770 | _x_x_mozilla_cycle_collect,1026 09:39:29 INFO - PID 29770 | __end_cc_report 09:39:29 INFO - PID 29770 | __startTimestamp1497631169159__endTimestamp 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | ------- Summary: start ------- 09:39:29 INFO - PID 29770 | Number of tests: 14 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#0] ai-astar Cycles:10 Average:110.10 Median:110.00 stddev:4.12 (3.7%) stddev-sans-first:3.16 09:39:29 INFO - PID 29770 | Values: 102.0 109.0 110.0 109.0 116.0 109.0 109.0 110.0 110.0 117.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#1] audio-beat-detection Cycles:10 Average:144.00 Median:148.50 stddev:19.08 (12.9%) stddev-sans-first:20.07 09:39:29 INFO - PID 29770 | Values: 151.0 127.0 146.0 176.0 124.0 146.0 153.0 123.0 169.0 125.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#2] audio-dft Cycles:10 Average:168.70 Median:165.00 stddev:10.21 (6.2%) stddev-sans-first:10.78 09:39:29 INFO - PID 29770 | Values: 166.0 164.0 164.0 162.0 164.0 175.0 172.0 195.0 163.0 162.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#3] audio-fft Cycles:10 Average:85.70 Median:75.00 stddev:25.46 (34.0%) stddev-sans-first:26.66 09:39:29 INFO - PID 29770 | Values: 74.0 77.0 76.0 155.0 73.0 73.0 74.0 84.0 97.0 74.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#4] audio-oscillator Cycles:10 Average:99.00 Median:82.00 stddev:26.87 (32.8%) stddev-sans-first:27.87 09:39:29 INFO - PID 29770 | Values: 83.0 82.0 136.0 82.0 82.0 83.0 132.0 83.0 82.0 145.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#5] imaging-gaussian-blur Cycles:10 Average:113.80 Median:114.00 stddev:0.63 (0.6%) stddev-sans-first:0.67 09:39:29 INFO - PID 29770 | Values: 114.0 114.0 115.0 114.0 114.0 113.0 113.0 113.0 114.0 114.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#6] imaging-darkroom Cycles:10 Average:150.60 Median:150.50 stddev:1.35 (0.9%) stddev-sans-first:1.42 09:39:29 INFO - PID 29770 | Values: 151.0 150.0 149.0 150.0 154.0 151.0 151.0 150.0 150.0 150.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:95.00 stddev:2.41 (2.5%) stddev-sans-first:1.99 09:39:29 INFO - PID 29770 | Values: 100.0 93.0 99.0 95.0 95.0 94.0 95.0 98.0 94.0 94.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#8] json-parse-financial Cycles:10 Average:54.80 Median:55.50 stddev:1.62 (2.9%) stddev-sans-first:1.72 09:39:29 INFO - PID 29770 | Values: 55.0 56.0 53.0 53.0 56.0 55.0 57.0 56.0 55.0 52.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#9] json-stringify-tinderbox Cycles:10 Average:55.40 Median:55.50 stddev:0.84 (1.5%) stddev-sans-first:0.67 09:39:29 INFO - PID 29770 | Values: 57.0 55.0 55.0 55.0 55.0 54.0 55.0 56.0 56.0 56.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#10] stanford-crypto-aes Cycles:10 Average:79.70 Median:78.50 stddev:2.87 (3.7%) stddev-sans-first:2.98 09:39:29 INFO - PID 29770 | Values: 78.0 77.0 78.0 78.0 78.0 82.0 79.0 85.0 78.0 84.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#11] stanford-crypto-ccm Cycles:10 Average:133.10 Median:132.00 stddev:6.87 (5.2%) stddev-sans-first:7.04 09:39:29 INFO - PID 29770 | Values: 128.0 128.0 131.0 130.0 131.0 140.0 135.0 126.0 133.0 149.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:191.40 Median:191.50 stddev:5.08 (2.7%) stddev-sans-first:4.59 09:39:29 INFO - PID 29770 | Values: 199.0 190.0 193.0 189.0 193.0 188.0 201.0 187.0 187.0 187.0 09:39:29 INFO - PID 29770 | 09:39:29 INFO - PID 29770 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.30 Median:72.00 stddev:2.21 (3.1%) stddev-sans-first:2.19 09:39:29 INFO - PID 29770 | Values: 70.0 72.0 75.0 77.0 70.0 71.0 72.0 71.0 72.0 73.0 09:39:29 INFO - PID 29770 | -------- Summary: end -------- 09:39:29 INFO - PID 29770 | 09:39:30 INFO - TEST-INFO | 29770: exit 0 09:39:30 INFO - TEST-OK | kraken | took 62642ms 09:39:30 INFO - SUITE-END | took 1179s 09:39:30 INFO - Completed test suite (00:19:40) 09:39:30 INFO - javascript benchmark 09:39:30 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7987.4322632947815, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3131.8434078296086, 3144.8427578621063, 3169.1918560767, 3177.5392568077627, 3188.4898416253404, 5908.67502287374, 6051.183090282811, 6077.604955677878, 6115.755369785204, 6124.908126378108, 5966.79116230932, 5974.31295401029, 6040.063790112528, 6050.939490605093, 6085.543584231178, 5507.366652834935, 5544.944550554484, 5588.413216612258, 5594.468525490092, 5665.5467562594895, 5597.020521408757, 5641.887162256752, 5660.575456840733, 5663.405342439047, 5690.658560486363, 5576.609637325389, 5627.0, 5639.577031722617, 5654.660720356792, 5674.858128546799, 5603.187537806995, 5648.915266271029, 5659.122835960433, 5681.0, 5705.6006079574445, 5598.44015598441, 5664.065429204176, 5666.1784041314195, 5690.943090569082, 5693.202951586781, 6026.849328766816, 6078.665673387962, 6139.754409823602, 6200.565960382775, 6201.0, 5539.529140023063, 6166.229221347332, 6416.711247993805, 6420.807375778734, 6572.145621069279, 6265.843353916143, 6629.237637671681, 6630.93369066308, 6631.668416579152, 6654.13496245485, 6119.632822030692, 6132.202813634199, 6136.7852125175405, 6150.231221097363, 6151.600145990586, 6726.529142960044, 6737.59574425536, 6778.7288508459105, 6780.72877084911, 6794.660266986631, 6231.345708700612, 6309.873802523924, 6337.33457986914, 6376.362363763679, 6387.648679322589, 6395.680215989182, 6444.387783160592, 6480.157579514633, 6487.967560162169, 6512.934870651327, 6423.74305027803, 6482.67586620667, 6505.251896031922, 6508.869822603521, 6518.608883467007, 6411.839704007344, 6482.870342593122, 6509.251436084816, 6536.869262614816, 6537.640429776408, 5148.613853960968, 5201.349831271091, 5217.373915130132, 5257.553107985864, 5261.316028916216, 4454.510003899569, 4476.820927162877, 4532.546745325441, 4544.909101817945, 4582.266837306015, 5698.544116470673, 5712.857178570486, 5713.342965558931, 5759.452851979056, 5760.855978600484, 6576.408123268929, 6622.63575503352, 6629.668516574152, 6636.8672626547195, 6656.4009239167735, 5593.804216852472, 5648.519875810603, 5716.914246286309, 5759.971200143972, 5759.971200144057, 5696.0, 5733.483986441241, 5741.5119714824705, 5744.856378590569, 5757.971210144006, 6288.779892703825, 6297.811065668037, 6299.590526615755, 6374.139491168633, 6389.8722025560155, 6370.108184854217, 6534.8890688582105, 6535.248446428722, 6573.80278591643, 6575.178102737158, 6204.007358822567, 6277.937220627735, 6279.183706118358, 6286.497080233479, 6294.905576416449, 6348.523860710373, 6376.489880809617, 6421.93578064232, 6426.228852537725, 6459.386358295955, 6574.178227721535, 6622.503312251697, 6652.368025037614, 6660.167479065117, 6660.933390666031, 6400.551961362846, 6409.198850143732, 6409.2949775525585, 6412.0, 6418.4865210783955, 6119.326874043941, 6401.615903045646, 6403.423691867754, 6440.774572889926, 6445.355464453704, 6095.969520152371, 6154.569180157346, 6184.033894414322, 6201.596896201732, 6203.875922481616, 6250.0, 6415.262244841716, 6445.452136568444, 6463.9980802975615, 6466.288708242184, 6255.812325630056, 6266.968665156827, 6270.184875966095, 6276.686165691606, 6278.4035516625845], "value": 5959.55138756992, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [700.2612244082494, 715.4634024481638, 745.8321877577544, 754.5284197376641, 758.1016495452885, 37314.25371492568, 37917.241655166916, 37919.431208531896, 38034.0, 38091.61908380912, 34872.47691284633, 35263.0, 35278.823605882, 35365.0, 35385.64614353856, 6391.808245752623, 6467.8059658210095, 6468.838279043014, 6479.74081036758, 6483.22201335838, 6410.839729006789, 6448.097266382711, 6470.126532918066, 6475.514336424763, 6515.869682606345, 6398.4561312288515, 6403.647799371032, 6431.067495213191, 6480.4491618212505, 6483.0, 6462.321456247097, 6485.870282594322, 6491.93508064918, 6505.967470162643, 6507.967460162693, 5855.092460668603, 5881.617694849864, 5891.086881533369, 5903.232579764646, 5909.645421274738, 31327.37345253082, 31583.84208078968, 31630.36739265225, 31634.0, 31685.683143168502, 3222.7582931280012, 3230.6769323067506, 3239.6922292382187, 3345.3643807676463, 3449.034270404291, 28297.717022829715, 28302.433951320858, 28336.574951375747, 28366.716332836615, 28394.0, 3613.3676606594004, 3656.542932133483, 3663.0292972362345, 3672.137047793766, 3718.0704823794053, 163948.0, 164824.0, 175776.0, 176262.0, 176546.0, 39492.407613885814, 39763.60236397599, 45817.77091114523, 46336.0, 46356.0, 46679.29981050287, 46983.06033879303, 47113.52886471091, 47153.0, 47163.76418117888, 15010.099394036393, 15091.924540377448, 15106.471273505595, 15248.695026099416, 15263.542093737206, 12450.626481205578, 12479.875201248053, 12498.125131240726, 12525.498980040878, 12527.43626536808, 13334.26661533625, 13548.525801596898, 13606.115602485806, 13719.245441500614, 13904.930475347559, 5506.449355064542, 5651.547876169897, 5748.971255143698, 5771.863041892719, 5783.450572195635, 975.4989805640691, 981.9018098190123, 982.7248370456284, 1010.4745532323298, 1024.5491983527224, 21950.780492194874, 22295.665565016538, 22843.31470055901, 23332.0, 29723.0, 1115.4924509348227, 1116.625930313354, 1123.4326665034105, 1123.8258069999, 1125.836753670713, 12986.0, 16103.516894493185, 16347.178379024204, 16358.0, 16419.753703694456, 210471.0, 212012.0, 212217.0, 213729.0, 213755.0, 52939.0, 53281.73359133257, 53333.200002, 53503.46496535063, 53653.195202072, 1435.8635929586674, 1476.29138013754, 1483.807105076333, 1484.2727063738905, 1485.7102864941448, 26270.0, 28506.42987140287, 28561.0, 28604.85697571499, 28744.0, 37179.8141009304, 37294.44058339073, 37337.0, 37388.43917341297, 37415.0, 195951.0, 196315.0, 197242.0, 197514.0, 197631.0, 31909.20226994344, 33162.66837331596, 33424.498632520044, 33888.83055584706, 33916.660833391354, 41694.58305416907, 42235.0, 42262.366064509675, 43125.353119703854, 44033.339499906884, 31122.688773112885, 31665.84167079242, 32456.675433245364, 32581.34837303288, 32703.307026513685, 31019.224519387197, 31408.528872067393, 31631.0, 32021.0, 32139.0, 36019.27961440704, 36349.81825090964, 36489.63510364862, 36540.45189322109, 36545.817270913474, 28348.71651283543, 30043.699563004964, 31102.533461997635, 31387.84306078455, 31759.0, 22280.0, 24443.633345499475, 24542.754572454047, 24545.386365341008, 24933.252002439956], "value": 16154.82977646387, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [491.6288202407182, 499.7132384110913, 511.2152845382338, 518.9299444574981, 524.4571868116499, 19018.429447116574, 19604.803951960475, 19783.703244451346, 20429.182832686693, 20439.795602043974, 21508.56982860342, 21897.0, 22228.333150005485, 22304.0, 22314.55370892581, 4695.272232803921, 4730.621550275987, 4922.70463772173, 4945.876353091166, 4998.700077995314, 5950.166976623276, 6040.275166979968, 6045.214122164112, 6071.544634152434, 6080.908786368186, 5628.859278518049, 5801.158831969362, 5857.0, 5883.058710606304, 6042.818715438544, 5706.77172913083, 5751.166080918264, 5767.855803604923, 5784.219130417382, 5792.189093526909, 5365.543928766059, 5376.51611354976, 5376.569874410038, 5380.112281473552, 5398.433164517708, 24733.25800225996, 25190.874045629836, 25200.243992680247, 25212.0, 25268.747312527008, 1859.0890463672704, 1893.195391958412, 1938.5832046110013, 1943.834774044208, 1955.4231501706888, 16748.83251167485, 17093.65812683752, 17125.65748685032, 17137.0, 17154.0, 2141.775113613079, 2165.101482884601, 2195.10000899632, 2195.242641288753, 2304.700388949426, 96109.0, 98116.50941745246, 98165.50917245439, 111267.44366278198, 117315.0, 19384.576927884016, 19386.224551018084, 19682.90158549227, 20323.491912702302, 20603.067818889835, 39561.604383956364, 39783.40324895129, 39785.20429591392, 39834.60165398367, 39963.80018099949, 10010.0, 10224.28430009907, 10351.0, 10406.895931040593, 10466.372017678963, 8505.10696376884, 8569.614367353484, 8594.441361311494, 8631.741047768577, 8636.093210212963, 10808.729781755519, 10855.185861060294, 10884.238103332691, 10928.032954068185, 11046.668599942015, 3785.167263202091, 4121.186677861731, 4178.91642167155, 4259.446271984684, 4325.6106950374615, 945.5981207986579, 950.8811398575178, 957.3011701457835, 982.6175258347706, 987.6000219910948, 18535.907320463582, 18766.155523001224, 21262.149514019267, 21440.24959126423, 22264.666030009565, 991.7867658453323, 1000.1848493477793, 1008.6016023670609, 1019.3021012539938, 1024.2420608749471, 10365.429901355346, 10402.167826573856, 10542.47287635615, 10653.520591573242, 10948.671539853816, 443980.0, 456989.0, 458162.0, 460995.0, 467911.0, 100651.0, 100791.0, 102007.0, 102814.0, 105026.47486762518, 1199.0647295109654, 1214.9210301330386, 1238.1642391385778, 1248.095131029996, 1249.6188662458037, 15723.371065157266, 15745.606359841096, 16602.66794664076, 16930.66138677244, 17189.742153867952, 44740.32889506725, 46756.0, 47077.293840593105, 48144.51855481401, 48612.2708159385, 59059.0, 59363.1095533576, 59534.40465595289, 59722.402775971685, 60004.0, 11063.557457701601, 11233.269837460866, 11276.830847537458, 11362.318260904372, 11429.485673144894, 13996.37016334247, 15581.688366232838, 15732.05607663544, 15805.051696898223, 15944.920275398548, 14265.857341426452, 14669.48656797007, 14677.77639597065, 14743.041702289745, 14856.925715371353, 10177.643782467578, 12709.36453177319, 12758.68103297425, 13680.179189248676, 14137.858621413654, 14414.063085899383, 14565.563033109023, 14570.781438278646, 14609.780853287422, 14644.26778661084, 11275.605353812578, 11565.306081635128, 11833.11251656112, 11835.644930652094, 11850.703732406413, 14196.077254978394, 14276.357563909442, 14324.355404006636, 14363.066400683922, 14417.92791036038], "value": 11000.745067856124, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1314.1786383510305, 1374.099964523237, 1380.02708090796, 1393.9651508712286, 1402.7404930087932, 12590.811137832929, 13157.868421315785, 13165.736685266289, 13188.472461101557, 13209.603711888634, 12764.361781910891, 13143.211407315568, 13145.211287322743, 13148.802767958465, 13215.867841321584, 2437.6465412515176, 2487.017628036924, 2496.8002559795264, 2499.0503608628696, 2509.6862892138483, 2431.8662473563945, 2487.5522405966917, 2529.633203185537, 2535.949281014379, 2548.7706106450414, 2415.1426243683504, 2466.1984854922134, 2475.9752402475924, 2480.6155045967903, 2493.6633554470186, 2387.964180537302, 2405.410674384769, 2409.084547871815, 2414.1912459326145, 2422.2975337152207, 2315.166540045582, 2357.599208134621, 2365.940851478727, 2368.7275963264274, 2384.6303822907475, 12657.43041563132, 12672.556460523929, 12826.35868206586, 12828.166169199065, 12839.358032098358, 6767.695453704595, 7010.123734533184, 7014.0, 7014.719411223545, 7016.964915175443, 4209.0950445654025, 4258.68059895509, 4301.978490107529, 4356.281213599752, 4434.49003364614, 1355.627202519315, 1360.347033423962, 1391.6033930329806, 1415.723933832903, 1417.029334905593, 18487.445376638723, 19212.615747685108, 19842.503937401536, 19906.701399479018, 19989.80010199894, 5158.767855446514, 5872.060470324727, 5980.162777211194, 6006.519478441714, 6075.179850720185, 14374.0, 14405.495807646683, 14411.495597654031, 14430.062045966979, 14437.85562144365, 7009.894851577231, 7073.82315442118, 7108.751193708195, 7113.359797618239, 7115.75094871677, 6288.465480434214, 6590.143281373391, 6633.005049242653, 6648.83377915556, 6665.166854143232, 5041.621878359065, 5133.743312834344, 5144.8713782155, 5151.501521761942, 5158.587313014949, 1589.348367169455, 1591.8726501879821, 1602.5512856400226, 1623.6346821965199, 1634.7629593708846, 867.947923124602, 868.2402897464718, 882.9337799665051, 894.7763059235191, 924.5977999570208, 6711.530192886548, 6834.8633027340165, 6906.133954408964, 6941.097657304518, 6980.336867997532, 652.1749986267375, 656.4977791989132, 676.8138761840534, 687.5153017123016, 693.8681650486392, 4225.450691410097, 4416.780779285447, 4931.432885218174, 5184.48155184486, 5340.8664783379945, 17290.308387664605, 17399.478015659297, 17722.822771772375, 17779.111044447727, 17789.110544472725, 15276.770848437282, 16916.577085572713, 17234.396796112327, 17359.0, 17496.650066998587, 9673.951630241803, 9787.608495660093, 9847.064528869745, 9917.603295868228, 10210.38737675727, 7337.3029562191505, 7614.314711675976, 7804.102528209329, 7978.561179134971, 8250.051244107004, 14738.852611473749, 15096.924515377354, 15357.769633455284, 15723.05661660304, 15853.128077955824, 14396.568102956928, 14904.478343257933, 15400.0, 15777.405899543106, 16087.195640218177, 12086.758264834478, 12422.192557483735, 12493.375331233221, 12556.37218139071, 12581.622551323475, 12285.815712764494, 12414.255144691348, 12430.502779889064, 12452.252864828139, 12506.624801255977, 10123.746906327106, 10142.645007424704, 10154.492275386054, 10307.639232626821, 10340.844887326546, 9906.306558540833, 9925.602975880884, 9939.701808945743, 10049.69850904474, 10157.085862272432, 8625.180607842496, 8884.244839188741, 8991.0, 9037.457752534869, 9058.320625953213, 6664.83337916556, 6700.195976482853, 6940.479464040116, 7030.121234845645, 7102.893456598052, 6657.700403481952, 6663.600183988976, 6715.899261511179, 6817.659117044029, 6884.48366372514], "value": 5872.724640652643, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [439.9560043995599, 457.75052596334996, 470.42842945820826, 471.75704512176213, 477.2125992113013, 6048.2137322148055, 6264.62412255265, 6322.272938612061, 6345.58753681011, 6368.936310636892, 6000.439885629746, 6078.5441091918065, 6091.421314975081, 6113.296970848353, 6229.345918678541, 5080.237964305346, 5110.744462776865, 5118.232265160219, 5129.871753206163, 5131.640785145041, 5087.931534377785, 5151.665141765792, 5159.2003239497935, 5199.610029247802, 5199.792008319662, 5045.445001049881, 5073.416557095944, 5076.0, 5085.211792172201, 5094.694318340893, 4721.622270218374, 4884.609231261491, 4923.236898280737, 5083.669561478492, 5093.312402825627, 4312.82748690052, 4349.151915376503, 4374.759388233646, 4378.277584198603, 4386.956130438687, 6008.819735407945, 6036.245469316335, 6038.57729958903, 6045.516358691294, 6075.17985072014, 5600.215969764236, 5603.60774745768, 5612.466815652507, 5617.775288988436, 5638.71806409682, 6525.543211975164, 6571.769988050443, 6573.1783527059115, 6588.110605068302, 6588.571742836748, 4753.9762301188275, 4764.737939413331, 4783.521647835223, 4807.42310922688, 4821.37322148122, 6865.27914568968, 6930.3367191874095, 6939.962232857446, 6942.687579058904, 6953.478489113337, 4881.219004959189, 4911.901761964812, 4939.3084968104495, 4943.777530011086, 4952.133376659071, 4936.48166942473, 5004.724740139327, 5009.899802004013, 5013.573846223039, 5017.974910125426, 5629.296337957755, 5643.843012182493, 5646.153077038395, 5649.0, 5674.97162514193, 6635.270120286765, 6658.3674550917585, 6664.400203981665, 6679.532432729759, 6684.0, 1617.1186703246758, 1732.5755189978536, 1740.2169023939277, 1747.8514326282154, 1753.509017475109, 1185.887340702632, 1193.2482536002262, 1194.6918124653491, 1202.6933132051272, 1204.4278967490372, 5528.834134975958, 5689.9146512802345, 5695.601307908407, 5726.0, 5743.655380677173, 6657.567258128206, 6694.330566943267, 6760.966195168992, 6775.932240677629, 6826.795196144124, 5825.300963884361, 5831.883362332815, 5835.387284335168, 5853.239078919713, 5860.677662728591, 3576.964230357663, 3578.570571531433, 3594.6405359463843, 3596.9100772480897, 3604.846449136304, 6260.937390626035, 6547.526806468506, 6580.012998050331, 6593.604383736991, 6605.6641396094665, 6955.478938689892, 6987.580745155307, 6992.2658120897595, 7009.299070093052, 7019.859602808017, 6539.803805885831, 6542.705578248991, 6582.045603387482, 6583.407493325623, 6595.0, 6647.833804154935, 6721.0, 6721.462283017249, 6746.4265537429865, 6749.392554670103, 6701.698423570853, 6705.1283333166375, 6705.8994115087335, 6721.529492935448, 6731.394174524316, 6511.218653761579, 6555.901661475177, 6557.147570815763, 6582.637954912526, 6602.471802255904, 4827.203511420576, 4891.80432782699, 4896.387951506062, 4901.926471103007, 4917.975410122926, 6773.06967514256, 6774.085498457645, 6791.320867913169, 6822.556533825285, 6826.249112597709, 6539.901901471577, 6589.6375699336995, 6621.404073633396, 6622.8344291393105, 6635.966820165868, 6581.07864898905, 6587.341265873374, 6599.769008084694, 6608.306127856506, 6621.702023409054, 6148.538859585459, 6470.7088181032905, 6477.481801455778, 6531.3468653134305, 6592.80221593353, 6439.846299136937, 6616.636085015371, 6617.371349721769, 6646.169228846395, 6658.0, 6424.229092508929, 6432.517561182836, 6445.484361251182, 6455.806325810233, 6476.967615161894], "value": 5046.73439795274, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [821.5235163605109, 830.2776584371597, 841.3731769831477, 841.8274253777976, 845.4251109245711, 16801.831981680196, 17461.301547938067, 17477.825221747793, 17485.47543573695, 17514.91242543787, 18306.542336441595, 19614.215431382763, 19678.212871485124, 19749.60500789987, 19765.60468790627, 993.9552720127575, 1000.5047501486774, 1003.6336737090945, 1006.0342071611262, 1010.7220514358573, 1018.4856647393057, 1026.2251999740186, 1027.337367398028, 1027.3579013116803, 1028.8816786069585, 726.4878260826131, 1044.4046893270838, 1048.355261514171, 1051.81593221186, 1055.672741450149, 740.2671355358184, 878.7056336127373, 1048.1143433798466, 1052.6789329254575, 1061.373789464212, 771.6836097200177, 776.0415886380316, 776.7553220735507, 778.2878666020584, 778.4161878591057, 17953.192106355116, 18414.0, 18628.813711862844, 18644.906775466035, 18680.439586812416, 18579.907100464545, 18870.81129188718, 19085.427437176906, 19126.0, 19138.23447062116, 14043.929780351134, 14143.434262629482, 14147.858521414757, 14231.644208894757, 14273.286335683279, 3392.9830350848333, 3484.163800687842, 3485.581730192393, 3520.612732599412, 3526.1713497328105, 89811.0, 92140.53929730375, 92788.53605731996, 95982.0, 100909.495452523, 13763.655908602364, 14027.649308767363, 14091.647708807363, 14107.224102674247, 14180.574582762534, 25343.74656253414, 26272.605910911352, 26301.0, 26700.198994029823, 26930.0, 7607.961960190164, 7619.619019049025, 7635.770926872203, 7685.03937007874, 7686.192949740197, 3954.723169378116, 3967.7420967637013, 4084.8774536763945, 4106.301928672133, 4145.398917156996, 4609.7695115244105, 4675.158471475099, 4687.906241875212, 4702.835400760957, 4716.716996980193, 833.7665453672981, 858.592168719853, 868.3227082875368, 871.1897934920585, 875.5709702245854, 664.5381459885333, 667.6594936582378, 682.5529278322707, 695.7425752471618, 713.3152173913102, 10932.104148498816, 12325.260484370967, 12422.503099875903, 12424.254544727346, 12730.872691273154, 684.3874732114829, 690.602903330587, 696.8397268628142, 702.9718811247493, 722.8734971380093, 5128.538431541179, 5156.278121063054, 5181.53366197044, 5315.495027972336, 5334.17320315344, 88595.0, 91815.54092229497, 91900.54049729709, 92240.0, 95065.0, 72235.0, 73837.63081184559, 73974.63012684902, 75187.24812751802, 75297.0, 69828.0, 70466.64766676236, 72082.0, 73139.63430182921, 74437.62781186168, 11211.159163062966, 11804.350760708243, 11813.881861181279, 12138.33239171854, 12418.254904705747, 29665.0, 31097.533536997416, 31792.0, 32033.839830800698, 32816.34367312688, 37427.0, 38809.6119038806, 40052.399214012396, 40446.1910761789, 40797.1840563193, 17508.562285942444, 17700.0, 17720.0, 18143.0, 18166.455006349832, 18494.630107398047, 18982.525436864187, 19370.903145484182, 19489.902550487157, 19526.21895124179, 17114.82885171182, 17446.47660570185, 17530.89998550589, 18189.18148683339, 18239.361622343153, 16268.267927943034, 17339.2197351117, 17676.116194190497, 17800.821991779918, 17897.910510447884, 17582.472525824247, 17583.560410989827, 17737.467875963743, 17742.11289435549, 17943.371981980566, 11365.00750387656, 12206.755864882474, 12397.876021240032, 12526.498940042296, 12618.305993170097, 13097.803532946822, 13193.0, 13214.141080829715, 13717.931410342884, 13792.448302067805], "value": 8272.361129375888, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1554.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 109.0, 110.0, 109.0, 116.0, 109.0, 109.0, 110.0, 110.0, 117.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 127.0, 146.0, 176.0, 124.0, 146.0, 153.0, 123.0, 169.0, 125.0], "value": 144.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 164.0, 164.0, 162.0, 164.0, 175.0, 172.0, 195.0, 163.0, 162.0], "value": 168.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 77.0, 76.0, 155.0, 73.0, 73.0, 74.0, 84.0, 97.0, 74.0], "value": 85.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 136.0, 82.0, 82.0, 83.0, 132.0, 83.0, 82.0, 145.0], "value": 99.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 115.0, 114.0, 114.0, 113.0, 113.0, 113.0, 114.0, 114.0], "value": 113.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 150.0, 149.0, 150.0, 154.0, 151.0, 151.0, 150.0, 150.0, 150.0], "value": 150.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 93.0, 99.0, 95.0, 95.0, 94.0, 95.0, 98.0, 94.0, 94.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 53.0, 53.0, 56.0, 55.0, 57.0, 56.0, 55.0, 52.0], "value": 54.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 55.0, 55.0, 55.0, 55.0, 54.0, 55.0, 56.0, 56.0, 56.0], "value": 55.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 77.0, 78.0, 78.0, 78.0, 82.0, 79.0, 85.0, 78.0, 84.0], "value": 79.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [128.0, 128.0, 131.0, 130.0, 131.0, 140.0, 135.0, 126.0, 133.0, 149.0], "value": 133.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [199.0, 190.0, 193.0, 189.0, 193.0, 188.0, 201.0, 187.0, 187.0, 187.0], "value": 191.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 72.0, 75.0, 77.0, 70.0, 71.0, 72.0, 71.0, 72.0, 73.0], "value": 72.3, "unit": "score"}]}]} 09:39:30 INFO - Return code: 0 09:39:30 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:39:30 INFO - # TBPL SUCCESS # 09:39:30 INFO - Running post-action listener: _resource_record_post_action 09:39:30 INFO - [mozharness: 2017-06-16 16:39:30.540706Z] Finished run-tests step (success) 09:39:30 INFO - Running post-run listener: _resource_record_post_run 09:39:30 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 16384; Write bytes: 432517120; Read time: 276; Write time: 364176 09:39:30 INFO - TinderboxPrint: CPU usage
13.3% 09:39:30 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 276 09:39:30 INFO - TinderboxPrint: I/O write bytes / time
432,517,120 / 364,176 09:39:30 INFO - TinderboxPrint: CPU idle
8,285.6 (86.7%) 09:39:30 INFO - TinderboxPrint: CPU user
1,213.4 (12.7%) 09:39:30 INFO - TinderboxPrint: Swap in / out
0 / 0 09:39:30 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 4096; Write bytes: 104902656; Read time: 56; Write time: 103568 09:39:30 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 09:39:30 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 8192; Write bytes: 326795264; Read time: 208; Write time: 260568 09:39:31 INFO - Running post-run listener: _upload_blobber_files 09:39:31 INFO - Blob upload gear active. 09:39:31 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:39:31 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 09:39:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:39:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:39:31 INFO - (blobuploader) - INFO - Open directory for files ... 09:39:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:39:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:32 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:39:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:32 INFO - (blobuploader) - INFO - Done attempting. 09:39:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:39:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:39:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:33 INFO - (blobuploader) - INFO - Done attempting. 09:39:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:39:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:34 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:39:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:34 INFO - (blobuploader) - INFO - Done attempting. 09:39:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:39:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:37 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:39:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:37 INFO - (blobuploader) - INFO - Done attempting. 09:39:37 INFO - (blobuploader) - INFO - Iteration through files over. 09:39:37 INFO - Return code: 0 09:39:37 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:39:37 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:39:37 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bb62e4b8adb259644063388a09bc94406d6202ff5ab7a53f0b1fe6f342577d295cc2005c885f7322f6104aca9ec51f16818f65cb4260fb048cbc86cf994694bd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dd22b59248202f7c70700a9c87ba3c1498462ee07bd091b1188ff02ef574fb0a11a57eb5f57b9258cd8f2d5f5d547d3fac5ea8fec006d0f9398dd7dddf7ee20", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/17234c8ec620171513727bad27c8abd16df08ea7b80370f0b8b5ab0b318a090f071a42dcf460467cfcb1f77937038ff2831c9098b827323bd6934f6459d58c08", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0510af2b76686472c17745f32e5b0162a7e448019696d890cefc2e721107094c84292a1a2269cb45a91ab2c016eceee0136481f7aa9b7dc30b0bede413daf60b"} 09:39:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:39:37 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:39:37 INFO - Contents: 09:39:37 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bb62e4b8adb259644063388a09bc94406d6202ff5ab7a53f0b1fe6f342577d295cc2005c885f7322f6104aca9ec51f16818f65cb4260fb048cbc86cf994694bd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dd22b59248202f7c70700a9c87ba3c1498462ee07bd091b1188ff02ef574fb0a11a57eb5f57b9258cd8f2d5f5d547d3fac5ea8fec006d0f9398dd7dddf7ee20", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/17234c8ec620171513727bad27c8abd16df08ea7b80370f0b8b5ab0b318a090f071a42dcf460467cfcb1f77937038ff2831c9098b827323bd6934f6459d58c08", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0510af2b76686472c17745f32e5b0162a7e448019696d890cefc2e721107094c84292a1a2269cb45a91ab2c016eceee0136481f7aa9b7dc30b0bede413daf60b"} 09:39:37 INFO - Running post-run listener: copy_logs_to_upload_dir 09:39:37 INFO - Copying logs to upload dir... 09:39:37 INFO - mkdir: /builds/slave/test/build/upload/logs 09:39:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1256.745923 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2017-06-16 09:39:37.585356) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-06-16 09:39:37.589337) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bb62e4b8adb259644063388a09bc94406d6202ff5ab7a53f0b1fe6f342577d295cc2005c885f7322f6104aca9ec51f16818f65cb4260fb048cbc86cf994694bd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dd22b59248202f7c70700a9c87ba3c1498462ee07bd091b1188ff02ef574fb0a11a57eb5f57b9258cd8f2d5f5d547d3fac5ea8fec006d0f9398dd7dddf7ee20", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/17234c8ec620171513727bad27c8abd16df08ea7b80370f0b8b5ab0b318a090f071a42dcf460467cfcb1f77937038ff2831c9098b827323bd6934f6459d58c08", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0510af2b76686472c17745f32e5b0162a7e448019696d890cefc2e721107094c84292a1a2269cb45a91ab2c016eceee0136481f7aa9b7dc30b0bede413daf60b"} build_url:https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011311 build_url: 'https://queue.taskcluster.net/v1/task/PX2TKEAnQPGMbf97rs9W-w/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bb62e4b8adb259644063388a09bc94406d6202ff5ab7a53f0b1fe6f342577d295cc2005c885f7322f6104aca9ec51f16818f65cb4260fb048cbc86cf994694bd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dd22b59248202f7c70700a9c87ba3c1498462ee07bd091b1188ff02ef574fb0a11a57eb5f57b9258cd8f2d5f5d547d3fac5ea8fec006d0f9398dd7dddf7ee20", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/17234c8ec620171513727bad27c8abd16df08ea7b80370f0b8b5ab0b318a090f071a42dcf460467cfcb1f77937038ff2831c9098b827323bd6934f6459d58c08", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0510af2b76686472c17745f32e5b0162a7e448019696d890cefc2e721107094c84292a1a2269cb45a91ab2c016eceee0136481f7aa9b7dc30b0bede413daf60b"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-06-16 09:39:37.613183) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:39:37.613486) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1258088b6da462a47ba2cd90000001a2-1497629787.626754-1719860955 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004411 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-06-16 09:39:37.696850) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-06-16 09:39:37.697255) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-06-16 09:39:37.697562) ========= ========= Total master_lag: 0.18 =========